"go test -v -timeout 1h0m0s -remote TestCryptDrive: -verbose" - Starting (try 1/5)
=== RUN   TestNewNameEncryptionMode
--- PASS: TestNewNameEncryptionMode (0.00s)
=== RUN   TestNewNameEncryptionModeString
--- PASS: TestNewNameEncryptionModeString (0.00s)
=== RUN   TestEncodeFileNameBase32
--- PASS: TestEncodeFileNameBase32 (0.00s)
=== RUN   TestEncodeFileNameBase64
--- PASS: TestEncodeFileNameBase64 (0.00s)
=== RUN   TestEncodeFileNameBase32768
--- PASS: TestEncodeFileNameBase32768 (0.00s)
=== RUN   TestDecodeFileNameBase32
--- PASS: TestDecodeFileNameBase32 (0.00s)
=== RUN   TestDecodeFileNameBase64
--- PASS: TestDecodeFileNameBase64 (0.00s)
=== RUN   TestDecodeFileNameBase32768
--- PASS: TestDecodeFileNameBase32768 (0.00s)
=== RUN   TestEncryptSegmentBase32
--- PASS: TestEncryptSegmentBase32 (0.00s)
=== RUN   TestEncryptSegmentBase64
--- PASS: TestEncryptSegmentBase64 (0.00s)
=== RUN   TestEncryptSegmentBase32768
--- PASS: TestEncryptSegmentBase32768 (0.00s)
=== RUN   TestDecryptSegmentBase32
--- PASS: TestDecryptSegmentBase32 (0.00s)
=== RUN   TestDecryptSegmentBase64
--- PASS: TestDecryptSegmentBase64 (0.00s)
=== RUN   TestDecryptSegmentBase32768
--- PASS: TestDecryptSegmentBase32768 (0.00s)
=== RUN   TestStandardEncryptFileNameBase32
--- PASS: TestStandardEncryptFileNameBase32 (0.00s)
=== RUN   TestStandardEncryptFileNameBase64
--- PASS: TestStandardEncryptFileNameBase64 (0.00s)
=== RUN   TestStandardEncryptFileNameBase32768
--- PASS: TestStandardEncryptFileNameBase32768 (0.00s)
=== RUN   TestNonStandardEncryptFileName
--- PASS: TestNonStandardEncryptFileName (0.00s)
=== RUN   TestStandardDecryptFileNameBase32
--- PASS: TestStandardDecryptFileNameBase32 (0.00s)
=== RUN   TestStandardDecryptFileNameBase64
--- PASS: TestStandardDecryptFileNameBase64 (0.00s)
=== RUN   TestStandardDecryptFileNameBase32768
--- PASS: TestStandardDecryptFileNameBase32768 (0.00s)
=== RUN   TestNonStandardDecryptFileName
--- PASS: TestNonStandardDecryptFileName (0.00s)
=== RUN   TestEncDecMatches
--- PASS: TestEncDecMatches (0.00s)
=== RUN   TestStandardEncryptDirNameBase32
--- PASS: TestStandardEncryptDirNameBase32 (0.00s)
=== RUN   TestStandardEncryptDirNameBase64
--- PASS: TestStandardEncryptDirNameBase64 (0.00s)
=== RUN   TestStandardEncryptDirNameBase32768
--- PASS: TestStandardEncryptDirNameBase32768 (0.00s)
=== RUN   TestNonStandardEncryptDirName
--- PASS: TestNonStandardEncryptDirName (0.00s)
=== RUN   TestStandardDecryptDirNameBase32
--- PASS: TestStandardDecryptDirNameBase32 (0.00s)
=== RUN   TestStandardDecryptDirNameBase64
--- PASS: TestStandardDecryptDirNameBase64 (0.00s)
=== RUN   TestStandardDecryptDirNameBase32768
--- PASS: TestStandardDecryptDirNameBase32768 (0.00s)
=== RUN   TestNonStandardDecryptDirName
--- PASS: TestNonStandardDecryptDirName (0.00s)
=== RUN   TestEncryptedSize
--- PASS: TestEncryptedSize (0.00s)
=== RUN   TestDecryptedSize
--- PASS: TestDecryptedSize (0.00s)
=== RUN   TestNoncePointer
--- PASS: TestNoncePointer (0.00s)
=== RUN   TestNonceFromReader
--- PASS: TestNonceFromReader (0.00s)
=== RUN   TestNonceFromBuf
--- PASS: TestNonceFromBuf (0.00s)
=== RUN   TestNonceIncrement
--- PASS: TestNonceIncrement (0.00s)
=== RUN   TestNonceAdd
--- PASS: TestNonceAdd (0.00s)
=== RUN   TestRandomSource
--- PASS: TestRandomSource (0.59s)
=== RUN   TestEncryptDecrypt1
--- PASS: TestEncryptDecrypt1 (0.25s)
=== RUN   TestEncryptDecrypt32
--- PASS: TestEncryptDecrypt32 (1.13s)
=== RUN   TestEncryptDecrypt4096
--- PASS: TestEncryptDecrypt4096 (0.98s)
=== RUN   TestEncryptDecrypt65536
--- PASS: TestEncryptDecrypt65536 (0.89s)
=== RUN   TestEncryptDecrypt65537
--- PASS: TestEncryptDecrypt65537 (0.91s)
=== RUN   TestEncryptData
--- PASS: TestEncryptData (0.00s)
=== RUN   TestNewEncrypter
--- PASS: TestNewEncrypter (0.00s)
=== RUN   TestNewEncrypterErrUnexpectedEOF
--- PASS: TestNewEncrypterErrUnexpectedEOF (0.00s)
=== RUN   TestNewDecrypter
--- PASS: TestNewDecrypter (0.00s)
=== RUN   TestNewDecrypterErrUnexpectedEOF
--- PASS: TestNewDecrypterErrUnexpectedEOF (0.00s)
=== RUN   TestNewDecrypterSeekLimit
--- PASS: TestNewDecrypterSeekLimit (0.20s)
=== RUN   TestDecrypterCalculateUnderlying
--- PASS: TestDecrypterCalculateUnderlying (0.00s)
=== RUN   TestDecrypterRead
2025/10/20 02:20:19 ERROR : crypt: ignoring: failed to authenticate decrypted block - bad password?
--- PASS: TestDecrypterRead (0.00s)
=== RUN   TestDecrypterClose
--- PASS: TestDecrypterClose (0.00s)
=== RUN   TestPutGetBlock
--- PASS: TestPutGetBlock (0.00s)
=== RUN   TestKey
--- PASS: TestKey (0.23s)
=== RUN   TestIntegration
    fstests.go:438: Using remote "TestCryptDrive:"
2025/10/20 02:20:19 NOTICE: TestCryptDrive: Stopped server
2025/10/20 02:20:19 NOTICE: TestCryptDrive: Starting server
2025/10/20 02:20:19 DEBUG : Creating backend with remote "TestCryptDrive:rclone-test-letuyiv0difi"
2025/10/20 02:20:19 DEBUG : Using config file from "/home/rclone/.rclone.conf"
2025/10/20 02:20:19 DEBUG : Creating backend with remote "TestDrive:crypt/m0fsvv16kd50du6fnv7tmuif8cv0k7urp8hudi2vt853h5qg2490"
=== RUN   TestIntegration/FsCheckWrap
=== RUN   TestIntegration/FsCommand
=== RUN   TestIntegration/FsRmdirNotFound
=== RUN   TestIntegration/FsString
=== RUN   TestIntegration/FsName
=== RUN   TestIntegration/FsRoot
=== RUN   TestIntegration/FsRmdirEmpty
=== RUN   TestIntegration/FsMkdir
=== RUN   TestIntegration/FsMkdir/FsMkdirRmdirSubdir
2025/10/20 02:20:23 INFO  : dir/subdir: Making directory
2025/10/20 02:20:25 INFO  : dir/subdir: Removing directory
2025/10/20 02:20:27 INFO  : dir: Removing directory
2025/10/20 02:20:27 DEBUG : gbh5ioi619nhbt6teh71jdbef8: Rmdir: contains trashed file: "i24n0ln37pa2hv8pctddeuh73o"
=== RUN   TestIntegration/FsMkdir/FsListEmpty
=== RUN   TestIntegration/FsMkdir/FsListDirEmpty
=== RUN   TestIntegration/FsMkdir/FsListRDirEmpty
=== RUN   TestIntegration/FsMkdir/FsListDirNotFound
2025/10/20 02:20:28 ERROR : does not exist: error listing: directory not found
=== RUN   TestIntegration/FsMkdir/FsListRDirNotFound
2025/10/20 02:20:29 ERROR : does not exist: error listing: directory not found
=== RUN   TestIntegration/FsMkdir/FsEncoding
=== RUN   TestIntegration/FsMkdir/FsEncoding/control_chars
    fstests.go:707: testing "␀␁␂␃␄␅␆␇␈␉␊␋␌␍␎␏␐␑␒␓␔␕␖␗␘␙␚␛␜␝␞␟␡"
2025/10/20 02:20:31 DEBUG : ␀␁␂␃␄␅␆␇␈␉␊␋␌␍␎␏␐␑␒␓␔␕␖␗␘␙␚␛␜␝␞␟␡/␀␁␂␃␄␅␆␇␈␉␊␋␌␍␎␏␐␑␒␓␔␕␖␗␘␙␚␛␜␝␞␟␡: md5 = a30ee8b23b8907b5308c304854712b40 OK
2025/10/20 02:20:32 DEBUG : f5e9c92esko9m26sej116anh5babi4i0al2vne0nmg9mvm0d1b9nq1ttlhvs75nh03n25mqg1vfrohsj7ua930ba4p3c4g405vd56tmte6ccvf24guul4t5gib4nm25g5l7cglg1lpefefuvubu655p01tsluhjl8jduu4dtjlour146bad0: Rmdir: contains trashed file: "f5e9c92esko9m26sej116anh5babi4i0al2vne0nmg9mvm0d1b9nq1ttlhvs75nh03n25mqg1vfrohsj7ua930ba4p3c4g405vd56tmte6ccvf24guul4t5gib4nm25g5l7cglg1lpefefuvubu655p01tsluhjl8jduu4dtjlour146bad0"
=== RUN   TestIntegration/FsMkdir/FsEncoding/dot
    fstests.go:707: testing "．"
2025/10/20 02:20:35 DEBUG : ．/．: md5 = e7fe2779f41a19e9e7f36d390b7e8821 OK
2025/10/20 02:20:37 DEBUG : do1eshp7fq66o1l1ei9pomlig8: Rmdir: contains trashed file: "do1eshp7fq66o1l1ei9pomlig8"
=== RUN   TestIntegration/FsMkdir/FsEncoding/dot_dot
    fstests.go:707: testing "．．"
2025/10/20 02:20:39 DEBUG : ．．/．．: md5 = d4e6738f7ed8bf133f4b7a35f9c14d5f OK
2025/10/20 02:20:41 DEBUG : msnn42iarlnl4kchlpfbl49rq0: Rmdir: contains trashed file: "msnn42iarlnl4kchlpfbl49rq0"
=== RUN   TestIntegration/FsMkdir/FsEncoding/punctuation
    fstests.go:707: testing "!\"#$%&'()*+,-.／:;<=>?@[\\]^_`{|}~"
2025/10/20 02:20:44 DEBUG : !"#$%&'()*+,-.／:;<=>?@[\]^_`{|}~/!"#$%&'()*+,-.／:;<=>?@[\]^_`{|}~: md5 = b8afcf43eda5337804f4abee521b43bd OK
2025/10/20 02:20:45 DEBUG : hassubu97i2ift2pggdbt1cfp876l53bceemu9btjavl43jthqj7tasdbcmte4busfs27dmocs8na: Rmdir: contains trashed file: "hassubu97i2ift2pggdbt1cfp876l53bceemu9btjavl43jthqj7tasdbcmte4busfs27dmocs8na"
=== RUN   TestIntegration/FsMkdir/FsEncoding/leading_space
    fstests.go:707: testing " leading space"
2025/10/20 02:20:48 DEBUG :  leading space/ leading space: md5 = 68f1478681966643f873dab23db943a0 OK
2025/10/20 02:20:50 DEBUG : igstt54k5qp9e549r6pqm35hl8: Rmdir: contains trashed file: "igstt54k5qp9e549r6pqm35hl8"
=== RUN   TestIntegration/FsMkdir/FsEncoding/leading_tilde
    fstests.go:707: testing "~leading tilde"
2025/10/20 02:20:53 DEBUG : ~leading tilde/~leading tilde: md5 = 66889e3c30213bb71a06dce02309acf1 OK
2025/10/20 02:20:54 DEBUG : nevsnko0v27og2qt2iomj9cbi4: Rmdir: contains trashed file: "nevsnko0v27og2qt2iomj9cbi4"
=== RUN   TestIntegration/FsMkdir/FsEncoding/leading_CR
    fstests.go:707: testing "␍leading CR"
2025/10/20 02:20:57 DEBUG : ␍leading CR/␍leading CR: md5 = 5fbf09381dc97f43bb24c8382397ee04 OK
2025/10/20 02:20:58 DEBUG : a2h0eu6un2623343gk1tqj6ut4: Rmdir: contains trashed file: "a2h0eu6un2623343gk1tqj6ut4"
=== RUN   TestIntegration/FsMkdir/FsEncoding/leading_LF
    fstests.go:707: testing "␊leading LF"
2025/10/20 02:21:01 DEBUG : ␊leading LF/␊leading LF: md5 = 7c59831e4f0fe5fe08844e9b7cdbe96f OK
2025/10/20 02:21:03 DEBUG : u529vt6ubothc7lvqh76rsb288: Rmdir: contains trashed file: "u529vt6ubothc7lvqh76rsb288"
=== RUN   TestIntegration/FsMkdir/FsEncoding/leading_HT
    fstests.go:707: testing "␉leading HT"
2025/10/20 02:21:06 DEBUG : ␉leading HT/␉leading HT: md5 = 0732ea8a78b06f6431f966eef024ffcd OK
2025/10/20 02:21:07 DEBUG : uhsh7ikeumar00etd5nibokc00: Rmdir: contains trashed file: "uhsh7ikeumar00etd5nibokc00"
=== RUN   TestIntegration/FsMkdir/FsEncoding/leading_VT
    fstests.go:707: testing "␋leading VT"
2025/10/20 02:21:10 DEBUG : ␋leading VT/␋leading VT: md5 = 57f350debcee136e599259a271e0637e OK
2025/10/20 02:21:11 DEBUG : 5k8glf8j137rtplh8pf777kc6k: Rmdir: contains trashed file: "5k8glf8j137rtplh8pf777kc6k"
=== RUN   TestIntegration/FsMkdir/FsEncoding/leading_dot
    fstests.go:707: testing ".leading dot"
2025/10/20 02:21:14 DEBUG : .leading dot/.leading dot: md5 = bfed09ee4ae500a21602c0a4e7cb4b33 OK
2025/10/20 02:21:16 DEBUG : hc8mhlb9r1e05buvff53j7ps94: Rmdir: contains trashed file: "hc8mhlb9r1e05buvff53j7ps94"
=== RUN   TestIntegration/FsMkdir/FsEncoding/trailing_space
    fstests.go:707: testing "trailing space "
2025/10/20 02:21:19 DEBUG : trailing space /trailing space : md5 = 996a7927d1bac5e9a91e02b5433ce86c OK
2025/10/20 02:21:20 DEBUG : 85pi11ntdsjcdjq56s37obj3k8: Rmdir: contains trashed file: "85pi11ntdsjcdjq56s37obj3k8"
=== RUN   TestIntegration/FsMkdir/FsEncoding/trailing_CR
    fstests.go:707: testing "trailing CR␍"
2025/10/20 02:21:23 DEBUG : trailing CR␍/trailing CR␍: md5 = ce153b39b486f26e782abd40ec4a0847 OK
2025/10/20 02:21:24 DEBUG : 0e6sh7hqlktdhvg6jk5u8d06u0: Rmdir: contains trashed file: "0e6sh7hqlktdhvg6jk5u8d06u0"
=== RUN   TestIntegration/FsMkdir/FsEncoding/trailing_LF
    fstests.go:707: testing "trailing LF␊"
2025/10/20 02:21:27 DEBUG : trailing LF␊/trailing LF␊: md5 = 3840f125ba49593abd034cd142f84710 OK
2025/10/20 02:21:29 DEBUG : 90oud4k3ofajhl43rm1o73dvd8: Rmdir: contains trashed file: "90oud4k3ofajhl43rm1o73dvd8"
=== RUN   TestIntegration/FsMkdir/FsEncoding/trailing_HT
    fstests.go:707: testing "trailing HT␉"
2025/10/20 02:21:32 DEBUG : trailing HT␉/trailing HT␉: md5 = 81337359f1e8859fe4b2c7efd9512aec OK
2025/10/20 02:21:33 DEBUG : dfr970d3hh9t7tp17e6s5eukfk: Rmdir: contains trashed file: "dfr970d3hh9t7tp17e6s5eukfk"
=== RUN   TestIntegration/FsMkdir/FsEncoding/trailing_VT
    fstests.go:707: testing "trailing VT␋"
2025/10/20 02:21:36 DEBUG : trailing VT␋/trailing VT␋: md5 = 4b04201a48f9c77eed478c4aad9a7caf OK
2025/10/20 02:21:37 DEBUG : pd7ls3vh3ccrv2ib1dd61189cc: Rmdir: contains trashed file: "pd7ls3vh3ccrv2ib1dd61189cc"
=== RUN   TestIntegration/FsMkdir/FsEncoding/trailing_dot
    fstests.go:707: testing "trailing dot."
2025/10/20 02:21:40 DEBUG : trailing dot./trailing dot.: md5 = d4d3debec276ab0283333f67eea78a0c OK
2025/10/20 02:21:40 DEBUG : TestDrive: Token expired
2025/10/20 02:21:40 DEBUG : Config file has changed externally - reloading
2025/10/20 02:21:40 DEBUG : TestDrive: Loaded fresh token from config file
2025/10/20 02:21:40 DEBUG : TestDrive: Token refresh successful
2025/10/20 02:21:42 DEBUG : fmlmh67m08l9reo4o1doaon9i4: Rmdir: contains trashed file: "fmlmh67m08l9reo4o1doaon9i4"
=== RUN   TestIntegration/FsMkdir/FsEncoding/invalid_UTF-8
    fstests.go:707: testing "invalid utf-8\xfe"
2025/10/20 02:21:45 DEBUG : invalid utf-8�/invalid utf-8�: md5 = e531d3027729dbd42d0b3a807c1edecc OK
2025/10/20 02:21:46 DEBUG : toetsandc7pe3o6afhhq1cvja4: Rmdir: contains trashed file: "toetsandc7pe3o6afhhq1cvja4"
=== RUN   TestIntegration/FsMkdir/FsEncoding/URL_encoding
    fstests.go:707: testing "test%46.txt"
2025/10/20 02:21:49 DEBUG : test%46.txt/test%46.txt: md5 = b63459567d25b86cb3d2a05a739db750 OK
2025/10/20 02:21:51 DEBUG : eleoftpogh4o5ffkg9917cnfq4: Rmdir: contains trashed file: "eleoftpogh4o5ffkg9917cnfq4"
=== RUN   TestIntegration/FsMkdir/FsNewObjectNotFound
=== RUN   TestIntegration/FsMkdir/FsPutError
=== RUN   TestIntegration/FsMkdir/FsPutZeroLength
2025/10/20 02:21:57 DEBUG : zero-length-file: md5 = 8c6638621fe8bab3208691dea7078bac OK
=== RUN   TestIntegration/FsMkdir/FsOpenWriterAt
    fstests.go:786: FS has no OpenWriterAt interface
=== RUN   TestIntegration/FsMkdir/FsOpenChunkWriter
    fstests.go:819: FS has no OpenChunkWriter interface
=== RUN   TestIntegration/FsMkdir/FsChangeNotify
2025/10/20 02:21:58 INFO  : dir: Making directory
2025/10/20 02:21:59 INFO  : dir/subdir1: Making directory
2025/10/20 02:22:00 INFO  : dir/subdir3: Making directory
2025/10/20 02:22:00 DEBUG : Google drive root 'crypt/m0fsvv16kd50du6fnv7tmuif8cv0k7urp8hudi2vt853h5qg2490': Checking for changes on remote
2025/10/20 02:22:01 INFO  : dir/subdir2: Making directory
2025/10/20 02:22:01 DEBUG : Google drive root 'crypt/m0fsvv16kd50du6fnv7tmuif8cv0k7urp8hudi2vt853h5qg2490': Checking for changes on remote
2025/10/20 02:22:02 DEBUG : doChangeNotify("hello? sausage/êé/Hello, 世界/ \" ' @ < > & ? + ≠", 0)
2025/10/20 02:22:02 DEBUG : Ignoring notify for file1 or file2: "hello? sausage/êé/Hello, 世界/ \" ' @ < > & ? + ≠", 0
2025/10/20 02:22:02 DEBUG : doChangeNotify("hello? sausage/êé/Hello, 世界", 0)
2025/10/20 02:22:02 DEBUG : Ignoring notify for file1 or file2: "hello? sausage/êé/Hello, 世界", 0
2025/10/20 02:22:02 DEBUG : doChangeNotify("zero-length-file", 1)
2025/10/20 02:22:02 DEBUG : Google drive root 'crypt/m0fsvv16kd50du6fnv7tmuif8cv0k7urp8hudi2vt853h5qg2490': Checking for changes on remote
2025/10/20 02:22:03 DEBUG : dir/file2: md5 = b2e72e9049f90a15788fe3cb4da32c5a OK
2025/10/20 02:22:03 DEBUG : Google drive root 'crypt/m0fsvv16kd50du6fnv7tmuif8cv0k7urp8hudi2vt853h5qg2490': Checking for changes on remote
2025/10/20 02:22:04 DEBUG : Google drive root 'crypt/m0fsvv16kd50du6fnv7tmuif8cv0k7urp8hudi2vt853h5qg2490': Checking for changes on remote
2025/10/20 02:22:05 DEBUG : doChangeNotify("dir/subdir1", 0)
2025/10/20 02:22:05 DEBUG : doChangeNotify("zero-length-file", 1)
2025/10/20 02:22:05 DEBUG : doChangeNotify("dir", 0)
2025/10/20 02:22:05 DEBUG : dir/file4: md5 = 6fb1ea17b4f3af201061e4420c7d53dc OK
2025/10/20 02:22:05 DEBUG : Google drive root 'crypt/m0fsvv16kd50du6fnv7tmuif8cv0k7urp8hudi2vt853h5qg2490': Checking for changes on remote
2025/10/20 02:22:06 DEBUG : Google drive root 'crypt/m0fsvv16kd50du6fnv7tmuif8cv0k7urp8hudi2vt853h5qg2490': Checking for changes on remote
2025/10/20 02:22:07 DEBUG : dir/file3: md5 = bac58f0a39f05070e9af8034128cb95a OK
    fstests.go:931: Try 1/10 waiting for dirChanges and objChanges
2025/10/20 02:22:07 DEBUG : Google drive root 'crypt/m0fsvv16kd50du6fnv7tmuif8cv0k7urp8hudi2vt853h5qg2490': Checking for changes on remote
2025/10/20 02:22:08 DEBUG : doChangeNotify("dir/file2", 1)
2025/10/20 02:22:08 DEBUG : doChangeNotify("dir/subdir2", 0)
2025/10/20 02:22:08 DEBUG : doChangeNotify("dir/subdir3", 0)
2025/10/20 02:22:08 DEBUG : Google drive root 'crypt/m0fsvv16kd50du6fnv7tmuif8cv0k7urp8hudi2vt853h5qg2490': Checking for changes on remote
2025/10/20 02:22:09 DEBUG : Google drive root 'crypt/m0fsvv16kd50du6fnv7tmuif8cv0k7urp8hudi2vt853h5qg2490': Checking for changes on remote
    fstests.go:931: Try 2/10 waiting for dirChanges and objChanges
2025/10/20 02:22:10 DEBUG : Google drive root 'crypt/m0fsvv16kd50du6fnv7tmuif8cv0k7urp8hudi2vt853h5qg2490': Checking for changes on remote
2025/10/20 02:22:11 DEBUG : doChangeNotify("dir/file3", 1)
2025/10/20 02:22:11 DEBUG : doChangeNotify("dir/file4", 1)
2025/10/20 02:22:11 DEBUG : Google drive root 'crypt/m0fsvv16kd50du6fnv7tmuif8cv0k7urp8hudi2vt853h5qg2490': Checking for changes on remote
2025/10/20 02:22:12 DEBUG : Google drive root 'crypt/m0fsvv16kd50du6fnv7tmuif8cv0k7urp8hudi2vt853h5qg2490': Checking for changes on remote
2025/10/20 02:22:13 DEBUG : Google drive root 'crypt/m0fsvv16kd50du6fnv7tmuif8cv0k7urp8hudi2vt853h5qg2490': Checking for changes on remote
2025/10/20 02:22:14 DEBUG : doChangeNotify("dir/file4", 1)
2025/10/20 02:22:14 DEBUG : doChangeNotify("dir/file2", 1)
2025/10/20 02:22:14 DEBUG : Google drive root 'crypt/m0fsvv16kd50du6fnv7tmuif8cv0k7urp8hudi2vt853h5qg2490': Checking for changes on remote
2025/10/20 02:22:15 DEBUG : Google drive root 'crypt/m0fsvv16kd50du6fnv7tmuif8cv0k7urp8hudi2vt853h5qg2490': Checking for changes on remote
2025/10/20 02:22:16 DEBUG : Google drive root 'crypt/m0fsvv16kd50du6fnv7tmuif8cv0k7urp8hudi2vt853h5qg2490': Checking for changes on remote
2025/10/20 02:22:17 DEBUG : gbh5ioi619nhbt6teh71jdbef8: Rmdir: contains trashed file: "633fmaa0qic3kv3cladnu11pto"
2025/10/20 02:22:17 DEBUG : gbh5ioi619nhbt6teh71jdbef8: Rmdir: contains trashed file: "amq3bkuqh8mg4ohnbs2i3185uk"
2025/10/20 02:22:17 DEBUG : gbh5ioi619nhbt6teh71jdbef8: Rmdir: contains trashed file: "d26uovf0miqhd1mu3c9jbseq00"
2025/10/20 02:22:17 DEBUG : gbh5ioi619nhbt6teh71jdbef8: Rmdir: contains trashed file: "9ttr6ktchp8s75c384iri950b4"
2025/10/20 02:22:17 DEBUG : gbh5ioi619nhbt6teh71jdbef8: Rmdir: contains trashed file: "6lcfeqjd564osl9cuhasslpeto"
2025/10/20 02:22:17 DEBUG : gbh5ioi619nhbt6teh71jdbef8: Rmdir: contains trashed file: "hpv9vbsl47o6lm8alr8q8b1m60"
2025/10/20 02:22:17 DEBUG : doChangeNotify("dir/file3", 1)
=== RUN   TestIntegration/FsMkdir/FsPutFiles
2025/10/20 02:22:18 DEBUG : file name.txt: md5 = 24a2bd305b22cc045210cb286bd92cb1 OK
2025/10/20 02:22:20 DEBUG : hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: md5 = ae898a2c86b5519dc1b5313ee8b9e8e0 OK
2025/10/20 02:22:22 DEBUG : file name.txt: md5 = e76d3fdfd560928c114ae8ed1c1a318d OK
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FsListDirFile2
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FsListRDirFile2
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FsListR
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FsListRSubdir
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FsListDirRoot
2025/10/20 02:22:27 DEBUG : Creating backend with remote "TestCryptDrive:"
2025/10/20 02:22:27 DEBUG : Creating backend with remote "TestDrive:crypt"
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FsListRDirRoot
2025/10/20 02:22:27 DEBUG : Creating backend with remote "TestCryptDrive:"
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FsListSubdir
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FsListRSubdir#01
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FsListLevel2
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FsListRLevel2
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FsListFile1
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FsNewObject
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FsNewObjectCaseInsensitive
    fstests.go:1121: Not Case Insensitive
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FsListFile1and2
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FsNewObjectDir
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FsPurge
2025/10/20 02:22:36 DEBUG : dirToPurge/fileToPurge.txt: md5 = d8fbaaa950a671f07ed11fcf02f0aa36 OK
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FsPurgeRoot
2025/10/20 02:22:41 DEBUG : dirToPurgeFromRoot/fileToPurgeFromRoot.txt: md5 = 96e7f63df6c9d7b917e7e97211a19ba7 OK
2025/10/20 02:22:42 DEBUG : Creating backend with remote "TestCryptDrive:rclone-test-letuyiv0difi/dirToPurgeFromRoot"
2025/10/20 02:22:42 DEBUG : Creating backend with remote "TestDrive:crypt/m0fsvv16kd50du6fnv7tmuif8cv0k7urp8hudi2vt853h5qg2490/tvhnk8lggj1s3rabb486oe8ovivigpgp7blmvtprk7pv51ap3c60"
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FsListRootedSubdir
2025/10/20 02:22:45 DEBUG : Creating backend with remote "TestCryptDrive:rclone-test-letuyiv0difi/hello? sausage/êé"
2025/10/20 02:22:45 DEBUG : Creating backend with remote "TestDrive:crypt/m0fsvv16kd50du6fnv7tmuif8cv0k7urp8hudi2vt853h5qg2490/96gujs4dkgufj2s2d5t6mkrddg/elopgm497i0kjatjjfeqjhvg4k"
2025/10/20 02:22:50 DEBUG : a/b/c/d/e.txt: md5 = f4cd616a0bc5a4e979ad2b12e9440161 OK
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FsCopy
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FsCopy/Metadata
2025/10/20 02:22:58 DEBUG : test metadata copy.txt: md5 = 0c07b25b92fa8e963ec29158ef4d5961 OK
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FsMove
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FsMove/Metadata
2025/10/20 02:23:13 DEBUG : test metadata move.txt: md5 = 7868ad43b547eea6eca89daf338f84b8 OK
2025/10/20 02:23:13 DEBUG : Google drive root 'crypt/m0fsvv16kd50du6fnv7tmuif8cv0k7urp8hudi2vt853h5qg2490': Skipping btime metadata as can't update it on an existing file: 2025-10-20T02:23:12.351Z
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FsDirMove
2025/10/20 02:23:15 DEBUG : Creating backend with remote "TestCryptDrive:rclone-test-sopizof3xizi"
2025/10/20 02:23:15 DEBUG : Creating backend with remote "TestDrive:crypt/ksjm4c5gqumlfvmj5hokn4ht180598kpp7ia9emar0d71q0p71n0"
2025/10/20 02:23:24 DEBUG : Encrypted drive 'TestCryptDrive:rclone-test-sopizof3xizi': Purge remote
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FsRmdirFull
2025/10/20 02:23:24 DEBUG : Rmdir: contains trashed file: "jvrdogrnrblgdk6svqeu791rdk"
2025/10/20 02:23:24 DEBUG : Rmdir: contains trashed file: "tvhnk8lggj1s3rabb486oe8ovivigpgp7blmvtprk7pv51ap3c60"
2025/10/20 02:23:24 DEBUG : Rmdir: contains trashed file: "ruuqrs7tbf1d4t5glb6bcbp5rk"
2025/10/20 02:23:24 DEBUG : Rmdir: contains trashed file: "gbh5ioi619nhbt6teh71jdbef8"
2025/10/20 02:23:24 DEBUG : Rmdir: contains file: "96gujs4dkgufj2s2d5t6mkrddg"
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FsPrecision
=== RUN   TestIntegration/FsMkdir/FsPutFiles/ObjectString
=== RUN   TestIntegration/FsMkdir/FsPutFiles/ObjectFs
=== RUN   TestIntegration/FsMkdir/FsPutFiles/ObjectRemote
=== RUN   TestIntegration/FsMkdir/FsPutFiles/ObjectHashes
=== RUN   TestIntegration/FsMkdir/FsPutFiles/ObjectModTime
=== RUN   TestIntegration/FsMkdir/FsPutFiles/ObjectMimeType
=== RUN   TestIntegration/FsMkdir/FsPutFiles/ObjectMetadata
=== RUN   TestIntegration/FsMkdir/FsPutFiles/ObjectMetadata/mtime
2025/10/20 02:23:27 DEBUG : metadatatest: md5 = e9ebaed4fcde8e9f25d7c164043341c0 OK
=== RUN   TestIntegration/FsMkdir/FsPutFiles/ObjectSetMetadata
2025/10/20 02:23:30 DEBUG : test set metadata.txt: md5 = 25413a21dda8cd42210ec44f0f340a9e OK
    fstests.go:1728: SetMetadata returned fs.ErrorNotImplemented
=== RUN   TestIntegration/FsMkdir/FsPutFiles/ObjectSetModTime
=== RUN   TestIntegration/FsMkdir/FsPutFiles/ObjectSize
=== RUN   TestIntegration/FsMkdir/FsPutFiles/ObjectOpen
=== RUN   TestIntegration/FsMkdir/FsPutFiles/ObjectOpenSeek
=== RUN   TestIntegration/FsMkdir/FsPutFiles/ObjectOpenRange
=== RUN   TestIntegration/FsMkdir/FsPutFiles/ObjectPartialRead
=== RUN   TestIntegration/FsMkdir/FsPutFiles/ObjectUpdate
2025/10/20 02:23:44 DEBUG : file name.txt-should-be-ignored.bin: md5 = 498ce08b9158b3ecac1c8b77a4479a87 OK
=== RUN   TestIntegration/FsMkdir/FsPutFiles/ObjectStorable
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FsIsFile
2025/10/20 02:23:45 DEBUG : Creating backend with remote "TestCryptDrive:rclone-test-letuyiv0difi/hello? sausage/êé/Hello, 世界/ \" ' @ < > & ? + ≠/z.txt"
2025/10/20 02:23:45 DEBUG : Creating backend with remote "TestDrive:crypt/m0fsvv16kd50du6fnv7tmuif8cv0k7urp8hudi2vt853h5qg2490/96gujs4dkgufj2s2d5t6mkrddg/elopgm497i0kjatjjfeqjhvg4k/ua43qrl1hugkmo9sgaaa6fljgg/m9faeqldhkv5r8aeijp7g9s9kil7gn2l3rsj9l43nb06fnhu09r0/u4ipppammbskorbmr2jnsktems"
2025/10/20 02:23:49 DEBUG : fs cache: renaming child cache item "TestDrive:crypt/m0fsvv16kd50du6fnv7tmuif8cv0k7urp8hudi2vt853h5qg2490/96gujs4dkgufj2s2d5t6mkrddg/elopgm497i0kjatjjfeqjhvg4k/ua43qrl1hugkmo9sgaaa6fljgg/m9faeqldhkv5r8aeijp7g9s9kil7gn2l3rsj9l43nb06fnhu09r0/u4ipppammbskorbmr2jnsktems" to be canonical for parent "TestDrive:crypt/m0fsvv16kd50du6fnv7tmuif8cv0k7urp8hudi2vt853h5qg2490/96gujs4dkgufj2s2d5t6mkrddg/elopgm497i0kjatjjfeqjhvg4k/ua43qrl1hugkmo9sgaaa6fljgg/m9faeqldhkv5r8aeijp7g9s9kil7gn2l3rsj9l43nb06fnhu09r0"
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FsIsFile/FsRoot
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FsIsFileNotFound
2025/10/20 02:23:49 DEBUG : Creating backend with remote "TestCryptDrive:rclone-test-letuyiv0difi/not found.txt"
2025/10/20 02:23:49 DEBUG : Creating backend with remote "TestDrive:crypt/m0fsvv16kd50du6fnv7tmuif8cv0k7urp8hudi2vt853h5qg2490/jgn01lqi50h78b6hoirrg20eko"
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FromRoot
    fstests.go:1911: Opening root remote "TestCryptDrive:" path "rclone-test-letuyiv0difi" from "TestCryptDrive:rclone-test-letuyiv0difi"
2025/10/20 02:23:51 DEBUG : Creating backend with remote "TestCryptDrive:"
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FromRoot/List
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FromRoot/ListEntries
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FromRoot/ListR
2025/10/20 02:23:53 DEBUG : Google drive root 'crypt': Disabling ListR to work around bug in drive as multi listing (7) returned no entries
2025/10/20 02:23:53 DEBUG : Google drive root 'crypt': Recycled 7 entries
2025/10/20 02:23:54 DEBUG : Google drive root 'crypt': Re-enabling ListR as previous detection was in error
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FromRoot/Put
2025/10/20 02:23:55 DEBUG : rclone-test-letuyiv0difi/created from root.txt: md5 = 15c0593526a50a201dc978f2f646196c OK
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FromRoot/Put/Remove
=== RUN   TestIntegration/FsMkdir/FsPutFiles/PublicLink
2025/10/20 02:23:59 DEBUG : Google drive root 'crypt/m0fsvv16kd50du6fnv7tmuif8cv0k7urp8hudi2vt853h5qg2490': attempting to share single file '80abn8ft86uthvulkui23octdeuodrrspkhsk4hav33t59ipblug'
2025/10/20 02:24:00 DEBUG : Google drive root 'crypt/m0fsvv16kd50du6fnv7tmuif8cv0k7urp8hudi2vt853h5qg2490': attempting to share single file 'nolduc6vng08379n9fboa9fqe4'
2025/10/20 02:24:01 DEBUG : Google drive root 'crypt/m0fsvv16kd50du6fnv7tmuif8cv0k7urp8hudi2vt853h5qg2490': attempting to share single file '96gujs4dkgufj2s2d5t6mkrddg/elopgm497i0kjatjjfeqjhvg4k/ua43qrl1hugkmo9sgaaa6fljgg/m9faeqldhkv5r8aeijp7g9s9kil7gn2l3rsj9l43nb06fnhu09r0/u4ipppammbskorbmr2jnsktems'
2025/10/20 02:24:02 DEBUG : Google drive root 'crypt/m0fsvv16kd50du6fnv7tmuif8cv0k7urp8hudi2vt853h5qg2490': attempting to share single file 'nolduc6vng08379n9fboa9fqe4'
2025/10/20 02:24:04 DEBUG : Google drive root 'crypt/m0fsvv16kd50du6fnv7tmuif8cv0k7urp8hudi2vt853h5qg2490': attempting to share directory '96gujs4dkgufj2s2d5t6mkrddg/elopgm497i0kjatjjfeqjhvg4k/ua43qrl1hugkmo9sgaaa6fljgg/m9faeqldhkv5r8aeijp7g9s9kil7gn2l3rsj9l43nb06fnhu09r0'
2025/10/20 02:24:04 DEBUG : Google drive root 'crypt/m0fsvv16kd50du6fnv7tmuif8cv0k7urp8hudi2vt853h5qg2490': attempting to share directory '96gujs4dkgufj2s2d5t6mkrddg/elopgm497i0kjatjjfeqjhvg4k/ua43qrl1hugkmo9sgaaa6fljgg/m9faeqldhkv5r8aeijp7g9s9kil7gn2l3rsj9l43nb06fnhu09r0'
2025/10/20 02:24:05 DEBUG : Creating backend with remote "TestCryptDrive:rclone-test-xadizuf8pobu"
2025/10/20 02:24:05 DEBUG : Creating backend with remote "TestDrive:crypt/2m18d8d9im1amvvq8t10tipn4cnft61c42o326np4lu34joc8u10"
2025/10/20 02:24:08 DEBUG : somefile: md5 = c5a9d9ce51bc1c038975bec5a6d4abad OK
2025/10/20 02:24:08 DEBUG : Google drive root 'crypt/m0fsvv16kd50du6fnv7tmuif8cv0k7urp8hudi2vt853h5qg2490': attempting to share directory ''
2025/10/20 02:24:09 DEBUG : Encrypted drive 'TestCryptDrive:rclone-test-xadizuf8pobu': Purge remote
=== RUN   TestIntegration/FsMkdir/FsPutFiles/SetTier
    fstests.go:412: FS has no SetTier & GetTier interfaces
=== RUN   TestIntegration/FsMkdir/FsPutFiles/ObjectCheckWrap
=== RUN   TestIntegration/FsMkdir/FsPutFiles/Bucket
    fstests.go:2125: Not a bucket based backend
=== RUN   TestIntegration/FsMkdir/FsPutFiles/ObjectRemove
=== RUN   TestIntegration/FsMkdir/FsPutFiles/ObjectAbout
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FsPutStream
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FsPutStream/0
2025/10/20 02:24:13 DEBUG : cqiebell711479onsrbud2b5lc: Sending chunk 0 length 32
2025/10/20 02:24:14 DEBUG : piped data.txt: md5 = c6bd8f349231c65e2b07ab9ea92e0895 OK
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FsPutStream/100
2025/10/20 02:24:15 DEBUG : cqiebell711479onsrbud2b5lc: Sending chunk 0 length 148
2025/10/20 02:24:16 DEBUG : piped data.txt: md5 = d417d08a9a1151f2f88d5c163faff267 OK
=== RUN   TestIntegration/FsMkdir/FsPutFiles/Internal
=== RUN   TestIntegration/FsMkdir/FsPutFiles/Internal/ObjectInfo
2025/10/20 02:24:17 DEBUG : Creating backend with remote "/tmp/rclone-spool1195036892"
2025/10/20 02:24:17 DEBUG : hash_test_object: Computing md5 hash of encrypted source
=== RUN   TestIntegration/FsMkdir/FsPutFiles/Internal/ObjectInfoWrap
2025/10/20 02:24:17 DEBUG : Creating backend with remote "/tmp/rclone-spool2744396219"
2025/10/20 02:24:17 DEBUG : new_remote: Computing md5 hash of encrypted source
=== RUN   TestIntegration/FsMkdir/FsPutFiles/Internal/ComputeHash
2025/10/20 02:24:17 DEBUG : Creating backend with remote "/tmp/rclone-spool4253434184"
2025/10/20 02:24:18 DEBUG : compute_hash_test: md5 = 1de165351708d2e15315f44f3234afc0 OK
=== RUN   TestIntegration/FsMkdir/FsPutChunked
    fstests.go:2364: *crypt.Fs does not implement SetUploadChunkSizer
=== RUN   TestIntegration/FsMkdir/FsCopyChunked
    fstests.go:2485: *crypt.Fs does not implement SetCopyCutoff
=== RUN   TestIntegration/FsMkdir/FsUploadUnknownSize
=== RUN   TestIntegration/FsMkdir/FsUploadUnknownSize/FsPutUnknownSize
2025/10/20 02:24:20 DEBUG : 5t6fllu4sbjea82tuvhkr8g5779c8gu1qrjbjcj5lupfmsp501n0: Sending chunk 0 length 148
2025/10/20 02:24:21 DEBUG : unknown-size-put.txt: md5 = c703c28a0e5b69610f32ee2db282b003 OK
=== RUN   TestIntegration/FsMkdir/FsUploadUnknownSize/FsUpdateUnknownSize
2025/10/20 02:24:23 DEBUG : unknown-size-update.txt: md5 = 7dd1119ca85381a717dfd6747b3c5446 OK
2025/10/20 02:24:24 DEBUG : i60g7a9vietemeugj4vko3pcqb41or1fldle4lnp7rp5c64fh8ng: Sending chunk 0 length 248
2025/10/20 02:24:25 DEBUG : unknown-size-update.txt: md5 = fac6d5f2553258b86a1733623b43b861 OK
=== RUN   TestIntegration/FsMkdir/FsRootCollapse
2025/10/20 02:24:26 DEBUG : Creating backend with remote "TestCryptDrive:rclone-test-letuyiv0difi/deeper/nonexisting/directory"
2025/10/20 02:24:26 DEBUG : Creating backend with remote "TestDrive:crypt/m0fsvv16kd50du6fnv7tmuif8cv0k7urp8hudi2vt853h5qg2490/a8sv4gs52nbgdd9dahlimee280/fbehe2orn9mdrpoteiv7ibtqvo/486oifeu6kfc5kp8j3to8ir2s4"
=== RUN   TestIntegration/FsMkdir/FsDirSetModTime
=== RUN   TestIntegration/FsMkdir/FsMkdirMetadata
=== RUN   TestIntegration/FsMkdir/FsMkdirMetadata/Update
=== RUN   TestIntegration/FsMkdir/FsMkdirMetadata/CheckDirectory
=== RUN   TestIntegration/FsMkdir/FsDirectory
=== RUN   TestIntegration/FsMkdir/FsDirectory/ReadDirMetadata
=== RUN   TestIntegration/FsMkdir/FsDirectory/WriteDirMetadata
=== RUN   TestIntegration/FsMkdir/FsDirectory/WriteDirSetModTime
=== RUN   TestIntegration/FsMkdir/FsDirectory/DirectoryCheckWrap
=== RUN   TestIntegration/FsShutdown
    fstests.go:2831: Shutdown method not supported
--- PASS: TestIntegration (257.61s)
    --- PASS: TestIntegration/FsCheckWrap (0.00s)
    --- PASS: TestIntegration/FsCommand (0.00s)
    --- PASS: TestIntegration/FsRmdirNotFound (0.22s)
    --- PASS: TestIntegration/FsString (0.00s)
    --- PASS: TestIntegration/FsName (0.00s)
    --- PASS: TestIntegration/FsRoot (0.00s)
    --- PASS: TestIntegration/FsRmdirEmpty (0.66s)
    --- PASS: TestIntegration/FsMkdir (254.62s)
        --- PASS: TestIntegration/FsMkdir/FsMkdirRmdirSubdir (4.36s)
        --- PASS: TestIntegration/FsMkdir/FsListEmpty (0.19s)
        --- PASS: TestIntegration/FsMkdir/FsListDirEmpty (0.25s)
        --- PASS: TestIntegration/FsMkdir/FsListRDirEmpty (0.23s)
        --- PASS: TestIntegration/FsMkdir/FsListDirNotFound (0.24s)
        --- PASS: TestIntegration/FsMkdir/FsListRDirNotFound (0.24s)
        --- PASS: TestIntegration/FsMkdir/FsEncoding (82.55s)
            --- PASS: TestIntegration/FsMkdir/FsEncoding/control_chars (4.11s)
            --- PASS: TestIntegration/FsMkdir/FsEncoding/dot (4.19s)
            --- PASS: TestIntegration/FsMkdir/FsEncoding/dot_dot (4.46s)
            --- PASS: TestIntegration/FsMkdir/FsEncoding/punctuation (4.35s)
            --- PASS: TestIntegration/FsMkdir/FsEncoding/leading_space (4.34s)
            --- PASS: TestIntegration/FsMkdir/FsEncoding/leading_tilde (4.59s)
            --- PASS: TestIntegration/FsMkdir/FsEncoding/leading_CR (4.16s)
            --- PASS: TestIntegration/FsMkdir/FsEncoding/leading_LF (4.32s)
            --- PASS: TestIntegration/FsMkdir/FsEncoding/leading_HT (4.31s)
            --- PASS: TestIntegration/FsMkdir/FsEncoding/leading_VT (4.34s)
            --- PASS: TestIntegration/FsMkdir/FsEncoding/leading_dot (4.41s)
            --- PASS: TestIntegration/FsMkdir/FsEncoding/trailing_space (4.15s)
            --- PASS: TestIntegration/FsMkdir/FsEncoding/trailing_CR (4.38s)
            --- PASS: TestIntegration/FsMkdir/FsEncoding/trailing_LF (4.50s)
            --- PASS: TestIntegration/FsMkdir/FsEncoding/trailing_HT (4.23s)
            --- PASS: TestIntegration/FsMkdir/FsEncoding/trailing_VT (4.28s)
            --- PASS: TestIntegration/FsMkdir/FsEncoding/trailing_dot (4.33s)
            --- PASS: TestIntegration/FsMkdir/FsEncoding/invalid_UTF-8 (4.56s)
            --- PASS: TestIntegration/FsMkdir/FsEncoding/URL_encoding (4.30s)
        --- PASS: TestIntegration/FsMkdir/FsNewObjectNotFound (0.46s)
        --- PASS: TestIntegration/FsMkdir/FsPutError (3.53s)
        --- PASS: TestIntegration/FsMkdir/FsPutZeroLength (3.21s)
        --- SKIP: TestIntegration/FsMkdir/FsOpenWriterAt (0.00s)
        --- SKIP: TestIntegration/FsMkdir/FsOpenChunkWriter (0.00s)
        --- PASS: TestIntegration/FsMkdir/FsChangeNotify (18.58s)
        --- PASS: TestIntegration/FsMkdir/FsPutFiles (122.59s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListDirFile2 (1.19s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListRDirFile2 (1.23s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListR (1.25s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListRSubdir (0.94s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListDirRoot (0.59s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListRDirRoot (0.40s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListSubdir (0.51s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListRSubdir#01 (0.46s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListLevel2 (0.50s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListRLevel2 (1.26s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListFile1 (1.29s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsNewObject (0.24s)
            --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FsNewObjectCaseInsensitive (0.00s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListFile1and2 (1.19s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsNewObjectDir (0.21s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsPurge (5.27s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsPurgeRoot (6.07s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListRootedSubdir (7.64s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsCopy (8.97s)
                --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsCopy/Metadata (5.38s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsMove (13.88s)
                --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsMove/Metadata (4.19s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsDirMove (8.77s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsRmdirFull (0.28s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsPrecision (0.00s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectString (0.24s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectFs (0.29s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectRemote (0.24s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectHashes (0.25s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectModTime (0.22s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectMimeType (0.21s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectMetadata (2.42s)
                --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectMetadata/mtime (2.12s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectSetMetadata (2.45s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectSetModTime (0.98s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectSize (0.27s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectOpen (1.25s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectOpenSeek (1.57s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectOpenRange (6.44s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectPartialRead (0.86s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectUpdate (2.59s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectStorable (0.25s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsIsFile (3.98s)
                --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsIsFile/FsRoot (0.00s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsIsFileNotFound (1.81s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/FromRoot (8.00s)
                --- PASS: TestIntegration/FsMkdir/FsPutFiles/FromRoot/List (1.23s)
                --- PASS: TestIntegration/FsMkdir/FsPutFiles/FromRoot/ListEntries (0.22s)
                --- PASS: TestIntegration/FsMkdir/FsPutFiles/FromRoot/ListR (1.96s)
                --- PASS: TestIntegration/FsMkdir/FsPutFiles/FromRoot/Put (4.51s)
                    --- PASS: TestIntegration/FsMkdir/FsPutFiles/FromRoot/Put/Remove (1.71s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/PublicLink (10.80s)
            --- SKIP: TestIntegration/FsMkdir/FsPutFiles/SetTier (0.00s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectCheckWrap (0.24s)
            --- SKIP: TestIntegration/FsMkdir/FsPutFiles/Bucket (0.00s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectRemove (1.95s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectAbout (0.19s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsPutStream (4.91s)
                --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsPutStream/0 (2.53s)
                --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsPutStream/100 (2.39s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/Internal (2.88s)
                --- PASS: TestIntegration/FsMkdir/FsPutFiles/Internal/ObjectInfo (0.00s)
                --- PASS: TestIntegration/FsMkdir/FsPutFiles/Internal/ObjectInfoWrap (0.00s)
                --- PASS: TestIntegration/FsMkdir/FsPutFiles/Internal/ComputeHash (2.88s)
        --- SKIP: TestIntegration/FsMkdir/FsPutChunked (0.00s)
        --- SKIP: TestIntegration/FsMkdir/FsCopyChunked (0.00s)
        --- PASS: TestIntegration/FsMkdir/FsUploadUnknownSize (6.09s)
            --- PASS: TestIntegration/FsMkdir/FsUploadUnknownSize/FsPutUnknownSize (2.25s)
            --- PASS: TestIntegration/FsMkdir/FsUploadUnknownSize/FsUpdateUnknownSize (3.84s)
        --- PASS: TestIntegration/FsMkdir/FsRootCollapse (1.77s)
        --- PASS: TestIntegration/FsMkdir/FsDirSetModTime (2.37s)
        --- PASS: TestIntegration/FsMkdir/FsMkdirMetadata (2.42s)
            --- PASS: TestIntegration/FsMkdir/FsMkdirMetadata/Update (0.73s)
            --- PASS: TestIntegration/FsMkdir/FsMkdirMetadata/CheckDirectory (0.00s)
        --- PASS: TestIntegration/FsMkdir/FsDirectory (3.37s)
            --- PASS: TestIntegration/FsMkdir/FsDirectory/ReadDirMetadata (0.00s)
            --- PASS: TestIntegration/FsMkdir/FsDirectory/WriteDirMetadata (0.80s)
            --- PASS: TestIntegration/FsMkdir/FsDirectory/WriteDirSetModTime (0.91s)
            --- PASS: TestIntegration/FsMkdir/FsDirectory/DirectoryCheckWrap (0.00s)
    --- SKIP: TestIntegration/FsShutdown (0.00s)
=== RUN   TestStandardBase32
    crypt_test.go:35: Skipping as -remote set
--- SKIP: TestStandardBase32 (0.00s)
=== RUN   TestStandardBase64
    crypt_test.go:56: Skipping as -remote set
--- SKIP: TestStandardBase64 (0.00s)
=== RUN   TestStandardBase32768
    crypt_test.go:78: Skipping as -remote set
--- SKIP: TestStandardBase32768 (0.00s)
=== RUN   TestOff
    crypt_test.go:101: Skipping as -remote set
--- SKIP: TestOff (0.00s)
=== RUN   TestObfuscate
    crypt_test.go:123: Skipping as -remote set
--- SKIP: TestObfuscate (0.00s)
=== RUN   TestNoDataObfuscate
    crypt_test.go:149: Skipping as -remote set
--- SKIP: TestNoDataObfuscate (0.00s)
PASS
ok  	github.com/rclone/rclone/backend/crypt	262.829s
"go test -v -timeout 1h0m0s -remote TestCryptDrive: -verbose" - Finished OK in 4m24.388138492s (try 1/5)