"./operations.test -test.v -test.timeout 1h0m0s -remote TestCryptSwift: -verbose" - Starting (try 1/5) 2024/12/21 02:23:49 DEBUG : Creating backend with remote "TestCryptSwift:rclone-test-kehimox8xoli" 2024/12/21 02:23:49 DEBUG : Using config file from "/home/rclone/.rclone.conf" 2024/12/21 02:23:49 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-kehimox8xoli.bin" 2024/12/21 02:23:49 DEBUG : Swift container crypt path rclone-test-kehimox8xoli.bin: Auto set use_segments_container to true 2024/12/21 02:23:50 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-kehimox8xoli" 2024/12/21 02:23:50 DEBUG : Swift container crypt path rclone-test-kehimox8xoli: Auto set use_segments_container to true 2024/12/21 02:23:51 DEBUG : Creating backend with remote "/tmp/rclone4162388848" === RUN TestDoMultiThreadCopy --- PASS: TestDoMultiThreadCopy (0.00s) === RUN TestMultithreadCalculateNumChunks === RUN TestMultithreadCalculateNumChunks/{size:1_chunkSize:65536_wantNumChunks:1} === RUN TestMultithreadCalculateNumChunks/{size:1048576_chunkSize:1_wantNumChunks:1048576} === RUN TestMultithreadCalculateNumChunks/{size:1048576_chunkSize:2_wantNumChunks:524288} === RUN TestMultithreadCalculateNumChunks/{size:1048577_chunkSize:2_wantNumChunks:524289} === RUN TestMultithreadCalculateNumChunks/{size:1048575_chunkSize:2_wantNumChunks:524288} --- PASS: TestMultithreadCalculateNumChunks (0.00s) --- PASS: TestMultithreadCalculateNumChunks/{size:1_chunkSize:65536_wantNumChunks:1} (0.00s) --- PASS: TestMultithreadCalculateNumChunks/{size:1048576_chunkSize:1_wantNumChunks:1048576} (0.00s) --- PASS: TestMultithreadCalculateNumChunks/{size:1048576_chunkSize:2_wantNumChunks:524288} (0.00s) --- PASS: TestMultithreadCalculateNumChunks/{size:1048577_chunkSize:2_wantNumChunks:524289} (0.00s) --- PASS: TestMultithreadCalculateNumChunks/{size:1048575_chunkSize:2_wantNumChunks:524288} (0.00s) === RUN TestMultithreadCopy run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" multithread_test.go:121: multithread writing not supported --- SKIP: TestMultithreadCopy (0.30s) === RUN TestMultithreadCopyAbort run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" multithread_test.go:121: multithread writing not supported --- SKIP: TestMultithreadCopyAbort (0.19s) === RUN TestSizeDiffers --- PASS: TestSizeDiffers (0.00s) === RUN TestReOpen === RUN TestReOpen/Normal === RUN TestReOpen/Normal/Basics 2024/12/21 02:23:51 DEBUG : potato: Seek from 10 to 0 === RUN TestReOpen/Normal/ErrorAtStart === RUN TestReOpen/Normal/WithErrors 2024/12/21 02:23:51 DEBUG : potato: Reopening on read failure after offset 2 bytes: retry 1/10: test error 2024/12/21 02:23:51 DEBUG : potato: Reopening on read failure after offset 3 bytes: retry 2/10: test error 2024/12/21 02:23:51 DEBUG : potato: Reopening on read failure after offset 6 bytes: retry 3/10: test error === RUN TestReOpen/Normal/TooManyErrors 2024/12/21 02:23:51 DEBUG : potato: Reopening on read failure after offset 2 bytes: retry 1/3: test error 2024/12/21 02:23:51 DEBUG : potato: Reopening on read failure after offset 3 bytes: retry 2/3: test error 2024/12/21 02:23:51 DEBUG : potato: Reopening on read failure after offset 6 bytes: retry 3/3: test error 2024/12/21 02:23:51 DEBUG : potato: Reopen failed after offset 6 bytes read: failed to reopen: too many retries === RUN TestReOpen/Normal/Seek 2024/12/21 02:23:51 DEBUG : potato: Reopening on read failure after offset 2 bytes: retry 0/10: test error 2024/12/21 02:23:51 DEBUG : potato: Reopening on read failure after offset 3 bytes: retry 1/10: test error 2024/12/21 02:23:51 DEBUG : potato: Seek from 5 to 2 === RUN TestReOpen/Normal/AccountRead === RUN TestReOpen/Normal/AccountReadDelay 2024/12/21 02:23:51 DEBUG : potato: Seek from 10 to 0 2024/12/21 02:23:51 DEBUG : potato: Seek from 10 to 0 2024/12/21 02:23:51 DEBUG : potato: Seek from 10 to 0 === RUN TestReOpen/Normal/AccountReadError === RUN TestReOpen/WithRangeOption === RUN TestReOpen/WithRangeOption/Basics 2024/12/21 02:23:51 DEBUG : potato: Seek from 7 to 0 === RUN TestReOpen/WithRangeOption/ErrorAtStart === RUN TestReOpen/WithRangeOption/WithErrors 2024/12/21 02:23:51 DEBUG : potato: Reopening on read failure after offset 2 bytes: retry 1/10: test error 2024/12/21 02:23:51 DEBUG : potato: Reopening on read failure after offset 3 bytes: retry 2/10: test error 2024/12/21 02:23:51 DEBUG : potato: Reopening on read failure after offset 6 bytes: retry 3/10: test error === RUN TestReOpen/WithRangeOption/TooManyErrors 2024/12/21 02:23:51 DEBUG : potato: Reopening on read failure after offset 2 bytes: retry 1/3: test error 2024/12/21 02:23:51 DEBUG : potato: Reopening on read failure after offset 3 bytes: retry 2/3: test error 2024/12/21 02:23:51 DEBUG : potato: Reopening on read failure after offset 6 bytes: retry 3/3: test error 2024/12/21 02:23:51 DEBUG : potato: Reopen failed after offset 6 bytes read: failed to reopen: too many retries === RUN TestReOpen/WithRangeOption/Seek 2024/12/21 02:23:51 DEBUG : potato: Reopening on read failure after offset 2 bytes: retry 0/10: test error 2024/12/21 02:23:51 DEBUG : potato: Reopening on read failure after offset 3 bytes: retry 1/10: test error 2024/12/21 02:23:51 DEBUG : potato: Seek from 5 to 2 2024/12/21 02:23:51 DEBUG : potato: Seek from 7 to 4 === RUN TestReOpen/WithRangeOption/AccountRead === RUN TestReOpen/WithRangeOption/AccountReadDelay 2024/12/21 02:23:51 DEBUG : potato: Seek from 7 to 0 2024/12/21 02:23:51 DEBUG : potato: Seek from 7 to 0 2024/12/21 02:23:51 DEBUG : potato: Seek from 7 to 0 === RUN TestReOpen/WithRangeOption/AccountReadError === RUN TestReOpen/WithSeekOption === RUN TestReOpen/WithSeekOption/Basics 2024/12/21 02:23:51 DEBUG : potato: Seek from 8 to 0 === RUN TestReOpen/WithSeekOption/ErrorAtStart === RUN TestReOpen/WithSeekOption/WithErrors 2024/12/21 02:23:51 DEBUG : potato: Reopening on read failure after offset 2 bytes: retry 1/10: test error 2024/12/21 02:23:51 DEBUG : potato: Reopening on read failure after offset 3 bytes: retry 2/10: test error 2024/12/21 02:23:51 DEBUG : potato: Reopening on read failure after offset 6 bytes: retry 3/10: test error === RUN TestReOpen/WithSeekOption/TooManyErrors 2024/12/21 02:23:51 DEBUG : potato: Reopening on read failure after offset 2 bytes: retry 1/3: test error 2024/12/21 02:23:51 DEBUG : potato: Reopening on read failure after offset 3 bytes: retry 2/3: test error 2024/12/21 02:23:51 DEBUG : potato: Reopening on read failure after offset 6 bytes: retry 3/3: test error 2024/12/21 02:23:51 DEBUG : potato: Reopen failed after offset 6 bytes read: failed to reopen: too many retries === RUN TestReOpen/WithSeekOption/Seek 2024/12/21 02:23:51 DEBUG : potato: Reopening on read failure after offset 2 bytes: retry 0/10: test error 2024/12/21 02:23:51 DEBUG : potato: Reopening on read failure after offset 3 bytes: retry 1/10: test error 2024/12/21 02:23:51 DEBUG : potato: Seek from 5 to 2 2024/12/21 02:23:51 DEBUG : potato: Seek from 7 to 5 === RUN TestReOpen/WithSeekOption/AccountRead === RUN TestReOpen/WithSeekOption/AccountReadDelay 2024/12/21 02:23:51 DEBUG : potato: Seek from 8 to 0 2024/12/21 02:23:51 DEBUG : potato: Seek from 8 to 0 2024/12/21 02:23:51 DEBUG : potato: Seek from 8 to 0 === RUN TestReOpen/WithSeekOption/AccountReadError === RUN TestReOpen/UnknownSize === RUN TestReOpen/UnknownSize/Basics 2024/12/21 02:23:51 DEBUG : potato: Seek from 9 to 0 === RUN TestReOpen/UnknownSize/ErrorAtStart === RUN TestReOpen/UnknownSize/WithErrors 2024/12/21 02:23:51 DEBUG : potato: Reopening on read failure after offset 2 bytes: retry 1/10: test error 2024/12/21 02:23:51 DEBUG : potato: Reopening on read failure after offset 3 bytes: retry 2/10: test error 2024/12/21 02:23:51 DEBUG : potato: Reopening on read failure after offset 6 bytes: retry 3/10: test error === RUN TestReOpen/UnknownSize/TooManyErrors 2024/12/21 02:23:51 DEBUG : potato: Reopening on read failure after offset 2 bytes: retry 1/3: test error 2024/12/21 02:23:51 DEBUG : potato: Reopening on read failure after offset 3 bytes: retry 2/3: test error 2024/12/21 02:23:51 DEBUG : potato: Reopening on read failure after offset 6 bytes: retry 3/3: test error 2024/12/21 02:23:51 DEBUG : potato: Reopen failed after offset 6 bytes read: failed to reopen: too many retries === RUN TestReOpen/UnknownSize/Seek 2024/12/21 02:23:51 DEBUG : potato: Reopening on read failure after offset 2 bytes: retry 0/10: test error 2024/12/21 02:23:51 DEBUG : potato: Reopening on read failure after offset 3 bytes: retry 1/10: test error 2024/12/21 02:23:51 DEBUG : potato: Seek from 5 to 2 2024/12/21 02:23:51 DEBUG : potato: Seek from 7 to 6 === RUN TestReOpen/UnknownSize/AccountRead === RUN TestReOpen/UnknownSize/AccountReadDelay 2024/12/21 02:23:51 DEBUG : potato: Seek from 9 to 0 2024/12/21 02:23:51 DEBUG : potato: Seek from 9 to 0 2024/12/21 02:23:51 DEBUG : potato: Seek from 9 to 0 === RUN TestReOpen/UnknownSize/AccountReadError --- PASS: TestReOpen (0.00s) --- PASS: TestReOpen/Normal (0.00s) --- PASS: TestReOpen/Normal/Basics (0.00s) --- PASS: TestReOpen/Normal/ErrorAtStart (0.00s) --- PASS: TestReOpen/Normal/WithErrors (0.00s) --- PASS: TestReOpen/Normal/TooManyErrors (0.00s) --- PASS: TestReOpen/Normal/Seek (0.00s) --- PASS: TestReOpen/Normal/AccountRead (0.00s) --- PASS: TestReOpen/Normal/AccountReadDelay (0.00s) --- PASS: TestReOpen/Normal/AccountReadError (0.00s) --- PASS: TestReOpen/WithRangeOption (0.00s) --- PASS: TestReOpen/WithRangeOption/Basics (0.00s) --- PASS: TestReOpen/WithRangeOption/ErrorAtStart (0.00s) --- PASS: TestReOpen/WithRangeOption/WithErrors (0.00s) --- PASS: TestReOpen/WithRangeOption/TooManyErrors (0.00s) --- PASS: TestReOpen/WithRangeOption/Seek (0.00s) --- PASS: TestReOpen/WithRangeOption/AccountRead (0.00s) --- PASS: TestReOpen/WithRangeOption/AccountReadDelay (0.00s) --- PASS: TestReOpen/WithRangeOption/AccountReadError (0.00s) --- PASS: TestReOpen/WithSeekOption (0.00s) --- PASS: TestReOpen/WithSeekOption/Basics (0.00s) --- PASS: TestReOpen/WithSeekOption/ErrorAtStart (0.00s) --- PASS: TestReOpen/WithSeekOption/WithErrors (0.00s) --- PASS: TestReOpen/WithSeekOption/TooManyErrors (0.00s) --- PASS: TestReOpen/WithSeekOption/Seek (0.00s) --- PASS: TestReOpen/WithSeekOption/AccountRead (0.00s) --- PASS: TestReOpen/WithSeekOption/AccountReadDelay (0.00s) --- PASS: TestReOpen/WithSeekOption/AccountReadError (0.00s) --- PASS: TestReOpen/UnknownSize (0.00s) --- PASS: TestReOpen/UnknownSize/Basics (0.00s) --- PASS: TestReOpen/UnknownSize/ErrorAtStart (0.00s) --- PASS: TestReOpen/UnknownSize/WithErrors (0.00s) --- PASS: TestReOpen/UnknownSize/TooManyErrors (0.00s) --- PASS: TestReOpen/UnknownSize/Seek (0.00s) --- PASS: TestReOpen/UnknownSize/AccountRead (0.00s) --- PASS: TestReOpen/UnknownSize/AccountReadDelay (0.00s) --- PASS: TestReOpen/UnknownSize/AccountReadError (0.00s) === RUN TestCheck run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:23:51 DEBUG : rutabaga: md5 = 79f1fa367c6a76d1bc7be7fc5d2114d9 OK === RUN TestCheck/1 === RUN TestCheck/2 2024/12/21 02:23:55 DEBUG : empty space: md5 = 8179c454e1375fd80c300890157d8aa2 OK === RUN TestCheck/3 2024/12/21 02:23:55 DEBUG : potato2: md5 = 68886c23c67a7c31e9a83da550d835a8 OK === RUN TestCheck/4 === RUN TestCheck/5 2024/12/21 02:23:56 DEBUG : remotepotato: md5 = 0abcd6de2c9b7d51555a69d33b9c9b36 OK === RUN TestCheck/6 === RUN TestCheck/7 --- PASS: TestCheck (6.52s) --- PASS: TestCheck/1 (0.15s) --- PASS: TestCheck/2 (0.17s) --- PASS: TestCheck/3 (0.05s) --- PASS: TestCheck/4 (0.14s) --- PASS: TestCheck/5 (0.15s) --- PASS: TestCheck/6 (0.17s) --- PASS: TestCheck/7 (0.16s) === RUN TestCheckFsError 2024/12/21 02:23:58 DEBUG : Creating backend with remote "nonexistent" 2024/12/21 02:23:58 DEBUG : Creating backend with remote "nonexistent" 2024/12/21 02:23:58 DEBUG : Local file system at /home/rclone/go/src/github.com/rclone/rclone/fs/operations/nonexistent: Waiting for checks to finish 2024/12/21 02:23:58 ERROR : Local file system at /home/rclone/go/src/github.com/rclone/rclone/fs/operations/nonexistent: error reading source root directory: directory not found 2024/12/21 02:23:58 NOTICE: Local file system at /home/rclone/go/src/github.com/rclone/rclone/fs/operations/nonexistent: 2 differences found 2024/12/21 02:23:58 NOTICE: Local file system at /home/rclone/go/src/github.com/rclone/rclone/fs/operations/nonexistent: 2 errors while checking --- PASS: TestCheckFsError (0.00s) === RUN TestCheckDownload run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:23:58 DEBUG : rutabaga: md5 = 6bc002f6e5ff9aae165cf2e69fa29493 OK === RUN TestCheckDownload/1 === RUN TestCheckDownload/2 2024/12/21 02:24:00 DEBUG : empty space: md5 = c33fc9263f5d1ac2c76f29ea161d5309 OK === RUN TestCheckDownload/3 2024/12/21 02:24:00 DEBUG : potato2: md5 = b890e8b03bd3273cc7af07f2d2a771ab OK === RUN TestCheckDownload/4 === RUN TestCheckDownload/5 2024/12/21 02:24:01 DEBUG : remotepotato: md5 = 810077f654c76b351f0b520678f6ce1d OK === RUN TestCheckDownload/6 === RUN TestCheckDownload/7 --- PASS: TestCheckDownload (5.26s) --- PASS: TestCheckDownload/1 (0.30s) --- PASS: TestCheckDownload/2 (0.23s) --- PASS: TestCheckDownload/3 (0.10s) --- PASS: TestCheckDownload/4 (0.26s) --- PASS: TestCheckDownload/5 (0.10s) --- PASS: TestCheckDownload/6 (0.19s) --- PASS: TestCheckDownload/7 (0.25s) === RUN TestCheckSizeOnly run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:24:03 DEBUG : rutabaga: md5 = 141918fadb235b9323ad985b9039d1da OK === RUN TestCheckSizeOnly/1 === RUN TestCheckSizeOnly/2 2024/12/21 02:24:04 DEBUG : empty space: md5 = bec43dacda9f205fe53bd7d390211812 OK === RUN TestCheckSizeOnly/3 2024/12/21 02:24:04 DEBUG : potato2: md5 = 0840eca6a7e0210541ff9c3326e58817 OK === RUN TestCheckSizeOnly/4 === RUN TestCheckSizeOnly/5 2024/12/21 02:24:05 DEBUG : remotepotato: md5 = 43383b62f1718a9886c3ea74ea3fcb2e OK === RUN TestCheckSizeOnly/6 === RUN TestCheckSizeOnly/7 --- PASS: TestCheckSizeOnly (4.36s) --- PASS: TestCheckSizeOnly/1 (0.05s) --- PASS: TestCheckSizeOnly/2 (0.15s) --- PASS: TestCheckSizeOnly/3 (0.14s) --- PASS: TestCheckSizeOnly/4 (0.25s) --- PASS: TestCheckSizeOnly/5 (0.16s) --- PASS: TestCheckSizeOnly/6 (0.17s) --- PASS: TestCheckSizeOnly/7 (0.15s) === RUN TestCheckEqualReaders --- PASS: TestCheckEqualReaders (0.00s) === RUN TestParseSumFile run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:24:07 DEBUG : test.sum: md5 = 3f89505ab63c1d752e0bcbdccfebac8c OK 2024/12/21 02:24:08 NOTICE: test.sum: improperly formatted checksum line 4 2024/12/21 02:24:08 NOTICE: test.sum: improperly formatted checksum line 5 2024/12/21 02:24:08 NOTICE: test.sum: improperly formatted checksum line 6 2024/12/21 02:24:08 NOTICE: test.sum: 2 warning(s) suppressed... 2024/12/21 02:24:08 DEBUG : test.sum: md5 = 5851101e6560fbf7c4b41cbe5510a5a8 OK 2024/12/21 02:24:08 NOTICE: test.sum: improperly formatted checksum line 4 2024/12/21 02:24:08 NOTICE: test.sum: improperly formatted checksum line 5 2024/12/21 02:24:08 NOTICE: test.sum: improperly formatted checksum line 6 2024/12/21 02:24:08 NOTICE: test.sum: 2 warning(s) suppressed... --- PASS: TestParseSumFile (1.07s) === RUN TestCheckSum run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:24:08 DEBUG : Creating backend with remote "TestCryptSwift:rclone-test-kehimox8xoli/data" 2024/12/21 02:24:08 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-kehimox8xoli/data.bin" 2024/12/21 02:24:09 DEBUG : Swift container crypt path rclone-test-kehimox8xoli/data.bin: Auto set use_segments_container to true 2024/12/21 02:24:09 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-kehimox8xoli/data" 2024/12/21 02:24:10 DEBUG : Swift container crypt path rclone-test-kehimox8xoli/data: Auto set use_segments_container to true check_test.go:354: Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli/data' lacks md5, skipping --- SKIP: TestCheckSum (2.06s) === RUN TestCheckSumDownload run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:24:10 DEBUG : Creating backend with remote "TestCryptSwift:rclone-test-kehimox8xoli/data" 2024/12/21 02:24:10 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-kehimox8xoli/data.bin" 2024/12/21 02:24:11 DEBUG : Swift container crypt path rclone-test-kehimox8xoli/data.bin: Auto set use_segments_container to true 2024/12/21 02:24:11 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-kehimox8xoli/data" 2024/12/21 02:24:12 DEBUG : Swift container crypt path rclone-test-kehimox8xoli/data: Auto set use_segments_container to true 2024/12/21 02:24:14 DEBUG : data/banana: md5 = 002f56a5ec6bacce96f2d9e105e6b011 OK 2024/12/21 02:24:14 DEBUG : test.sum: md5 = 0edbd9452505c5a140de6c4e4b4a30d3 OK === RUN TestCheckSumDownload/subtest1 2024/12/21 02:24:16 DEBUG : data/potato: md5 = b71f064accfff048ae2017d2d59c9db9 OK 2024/12/21 02:24:16 DEBUG : test.sum: md5 = a1db39d45c6ad298c63edbd8cba63c80 OK === RUN TestCheckSumDownload/subtest2 2024/12/21 02:24:17 DEBUG : test.sum: md5 = 5bfda42204e8a6abe8799e79e74c04ed OK === RUN TestCheckSumDownload/subtest3 2024/12/21 02:24:18 DEBUG : test.sum: md5 = 0afee2f9463d090a338bd41f3ccc1f3f OK === RUN TestCheckSumDownload/subtest4 2024/12/21 02:24:18 DEBUG : test.sum: md5 = 919bb69686c4a9e71f55c45c9a0e519b OK === RUN TestCheckSumDownload/subtest5 2024/12/21 02:24:19 DEBUG : test.sum: md5 = 62e4a0ae5fca149af3e8897778e50e51 OK === RUN TestCheckSumDownload/subtest6 2024/12/21 02:24:20 DEBUG : data/banana: md5 = 67da931d26ffb93dcbfede7c6953de36 OK 2024/12/21 02:24:21 DEBUG : data/potato: md5 = 410aac81ec79b75bc75c049f1299d1a0 OK 2024/12/21 02:24:21 DEBUG : test.sum: md5 = a8c936b1ea2c3678066fbacf49aa14fd OK === RUN TestCheckSumDownload/subtest7 --- PASS: TestCheckSumDownload (12.77s) --- PASS: TestCheckSumDownload/subtest1 (0.21s) --- PASS: TestCheckSumDownload/subtest2 (0.19s) --- PASS: TestCheckSumDownload/subtest3 (0.37s) --- PASS: TestCheckSumDownload/subtest4 (0.30s) --- PASS: TestCheckSumDownload/subtest5 (0.31s) --- PASS: TestCheckSumDownload/subtest6 (0.29s) --- PASS: TestCheckSumDownload/subtest7 (0.34s) === RUN TestApplyTransforms 2024/12/21 02:24:23 DEBUG : Creating backend with remote "TestCryptSwift:rclone-test-yugirim8zubi" 2024/12/21 02:24:23 DEBUG : Using config file from "/home/rclone/.rclone.conf" 2024/12/21 02:24:23 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-yugirim8zubi.bin" 2024/12/21 02:24:24 DEBUG : Swift container crypt path rclone-test-yugirim8zubi.bin: Auto set use_segments_container to true 2024/12/21 02:24:24 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-yugirim8zubi" 2024/12/21 02:24:25 DEBUG : Swift container crypt path rclone-test-yugirim8zubi: Auto set use_segments_container to true 2024/12/21 02:24:25 DEBUG : Creating backend with remote "/tmp/rclone4071160956" run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-yugirim8zubi'", Local "Local file system at /tmp/rclone4071160956", Modify Window "1ns" 2024/12/21 02:24:25 DEBUG : hello, world!: md5 = bf14ddb549d4019a123cf25c5bcbecfd OK upper checkfile vs. lower remote (without normalization) 2024/12/21 02:24:26 ERROR : hello, world!: sum not found 2024/12/21 02:24:26 ERROR : HELLO, WORLD!: file not in Encrypted drive 'TestCryptSwift:rclone-test-yugirim8zubi' 2024/12/21 02:24:26 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-yugirim8zubi': 1 files missing 2024/12/21 02:24:26 NOTICE: 1 hashes missing 2024/12/21 02:24:26 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-yugirim8zubi': 2 differences found 2024/12/21 02:24:26 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-yugirim8zubi': 2 errors while checking upper checkfile vs. lower remote (with normalization) 2024/12/21 02:24:26 DEBUG : hello, world!: md5 = 65a8e27d8879283831b664bd8b7f0ad4 OK 2024/12/21 02:24:26 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-yugirim8zubi': 0 differences found 2024/12/21 02:24:26 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-yugirim8zubi': 1 matching files 2024/12/21 02:24:26 DEBUG : Creating backend with remote "TestCryptSwift:rclone-test-favuris7pemu" 2024/12/21 02:24:26 DEBUG : Using config file from "/home/rclone/.rclone.conf" 2024/12/21 02:24:26 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-favuris7pemu.bin" 2024/12/21 02:24:26 DEBUG : Swift container crypt path rclone-test-favuris7pemu.bin: Auto set use_segments_container to true 2024/12/21 02:24:27 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-favuris7pemu" 2024/12/21 02:24:27 DEBUG : Swift container crypt path rclone-test-favuris7pemu: Auto set use_segments_container to true 2024/12/21 02:24:28 DEBUG : Creating backend with remote "/tmp/rclone1030996717" run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-favuris7pemu'", Local "Local file system at /tmp/rclone1030996717", Modify Window "1ns" 2024/12/21 02:24:28 DEBUG : HELLO, WORLD!: md5 = a8ca98b0148fe9ef090af37590691afb OK lower checkfile vs. upper remote (without normalization) 2024/12/21 02:24:29 ERROR : HELLO, WORLD!: sum not found 2024/12/21 02:24:29 ERROR : hello, world!: file not in Encrypted drive 'TestCryptSwift:rclone-test-favuris7pemu' 2024/12/21 02:24:29 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-favuris7pemu': 1 files missing 2024/12/21 02:24:29 NOTICE: 1 hashes missing 2024/12/21 02:24:29 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-favuris7pemu': 2 differences found 2024/12/21 02:24:29 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-favuris7pemu': 2 errors while checking lower checkfile vs. upper remote (with normalization) 2024/12/21 02:24:29 DEBUG : HELLO, WORLD!: md5 = 65a8e27d8879283831b664bd8b7f0ad4 OK 2024/12/21 02:24:29 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-favuris7pemu': 0 differences found 2024/12/21 02:24:29 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-favuris7pemu': 1 matching files 2024/12/21 02:24:29 DEBUG : Creating backend with remote "TestCryptSwift:rclone-test-cocahef1naju" 2024/12/21 02:24:29 DEBUG : Using config file from "/home/rclone/.rclone.conf" 2024/12/21 02:24:29 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-cocahef1naju.bin" 2024/12/21 02:24:29 DEBUG : Swift container crypt path rclone-test-cocahef1naju.bin: Auto set use_segments_container to true 2024/12/21 02:24:30 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-cocahef1naju" 2024/12/21 02:24:30 DEBUG : Swift container crypt path rclone-test-cocahef1naju: Auto set use_segments_container to true 2024/12/21 02:24:30 DEBUG : Creating backend with remote "/tmp/rclone2963638123" run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-cocahef1naju'", Local "Local file system at /tmp/rclone2963638123", Modify Window "1ns" 2024/12/21 02:24:31 DEBUG : HeLlO, wOrLd!: md5 = 1edc9d84b9a1066f743ac4ecdb2316eb OK lower checkfile vs. upperlowermixed remote (without normalization) 2024/12/21 02:24:32 ERROR : HeLlO, wOrLd!: sum not found 2024/12/21 02:24:32 ERROR : hello, world!: file not in Encrypted drive 'TestCryptSwift:rclone-test-cocahef1naju' 2024/12/21 02:24:32 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-cocahef1naju': 1 files missing 2024/12/21 02:24:32 NOTICE: 1 hashes missing 2024/12/21 02:24:32 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-cocahef1naju': 2 differences found 2024/12/21 02:24:32 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-cocahef1naju': 2 errors while checking lower checkfile vs. upperlowermixed remote (with normalization) 2024/12/21 02:24:32 DEBUG : HeLlO, wOrLd!: md5 = 65a8e27d8879283831b664bd8b7f0ad4 OK 2024/12/21 02:24:32 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-cocahef1naju': 0 differences found 2024/12/21 02:24:32 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-cocahef1naju': 1 matching files 2024/12/21 02:24:32 DEBUG : Creating backend with remote "TestCryptSwift:rclone-test-hogesuh2dazi" 2024/12/21 02:24:32 DEBUG : Using config file from "/home/rclone/.rclone.conf" 2024/12/21 02:24:32 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-hogesuh2dazi.bin" 2024/12/21 02:24:32 DEBUG : Swift container crypt path rclone-test-hogesuh2dazi.bin: Auto set use_segments_container to true 2024/12/21 02:24:33 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-hogesuh2dazi" 2024/12/21 02:24:33 DEBUG : Swift container crypt path rclone-test-hogesuh2dazi: Auto set use_segments_container to true 2024/12/21 02:24:34 DEBUG : Creating backend with remote "/tmp/rclone1382370959" run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-hogesuh2dazi'", Local "Local file system at /tmp/rclone1382370959", Modify Window "1ns" 2024/12/21 02:24:34 DEBUG : HELLO, WORLD!: md5 = b4faaeb553f2ce276fc07def7c2b3be4 OK upperlowermixed checkfile vs. upper remote (without normalization) 2024/12/21 02:24:35 ERROR : HELLO, WORLD!: sum not found 2024/12/21 02:24:35 ERROR : HeLlO, wOrLd!: file not in Encrypted drive 'TestCryptSwift:rclone-test-hogesuh2dazi' 2024/12/21 02:24:35 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-hogesuh2dazi': 1 files missing 2024/12/21 02:24:35 NOTICE: 1 hashes missing 2024/12/21 02:24:35 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-hogesuh2dazi': 2 differences found 2024/12/21 02:24:35 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-hogesuh2dazi': 2 errors while checking upperlowermixed checkfile vs. upper remote (with normalization) 2024/12/21 02:24:35 DEBUG : HELLO, WORLD!: md5 = 65a8e27d8879283831b664bd8b7f0ad4 OK 2024/12/21 02:24:35 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-hogesuh2dazi': 0 differences found 2024/12/21 02:24:35 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-hogesuh2dazi': 1 matching files 2024/12/21 02:24:35 DEBUG : Creating backend with remote "TestCryptSwift:rclone-test-fonezaw1wini" 2024/12/21 02:24:35 DEBUG : Using config file from "/home/rclone/.rclone.conf" 2024/12/21 02:24:35 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-fonezaw1wini.bin" 2024/12/21 02:24:35 DEBUG : Swift container crypt path rclone-test-fonezaw1wini.bin: Auto set use_segments_container to true 2024/12/21 02:24:36 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-fonezaw1wini" 2024/12/21 02:24:36 DEBUG : Swift container crypt path rclone-test-fonezaw1wini: Auto set use_segments_container to true 2024/12/21 02:24:37 DEBUG : Creating backend with remote "/tmp/rclone1016444737" run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-fonezaw1wini'", Local "Local file system at /tmp/rclone1016444737", Modify Window "1ns" 2024/12/21 02:24:37 DEBUG : 測試_Русский___ě_áñ: md5 = 6ffd045c269878ad08db9bee6ab05fdd OK NFD checkfile vs. NFC remote (without normalization) 2024/12/21 02:24:37 ERROR : 測試_Русский___ě_áñ: sum not found 2024/12/21 02:24:37 ERROR : 測試_Русский___ě_áñ: file not in Encrypted drive 'TestCryptSwift:rclone-test-fonezaw1wini' 2024/12/21 02:24:37 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-fonezaw1wini': 1 files missing 2024/12/21 02:24:37 NOTICE: 1 hashes missing 2024/12/21 02:24:37 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-fonezaw1wini': 2 differences found 2024/12/21 02:24:37 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-fonezaw1wini': 2 errors while checking NFD checkfile vs. NFC remote (with normalization) 2024/12/21 02:24:38 DEBUG : 測試_Русский___ě_áñ: md5 = 65a8e27d8879283831b664bd8b7f0ad4 OK 2024/12/21 02:24:38 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-fonezaw1wini': 0 differences found 2024/12/21 02:24:38 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-fonezaw1wini': 1 matching files 2024/12/21 02:24:38 DEBUG : Creating backend with remote "TestCryptSwift:rclone-test-bobewir0bixa" 2024/12/21 02:24:38 DEBUG : Using config file from "/home/rclone/.rclone.conf" 2024/12/21 02:24:38 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-bobewir0bixa.bin" 2024/12/21 02:24:38 DEBUG : Swift container crypt path rclone-test-bobewir0bixa.bin: Auto set use_segments_container to true 2024/12/21 02:24:39 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-bobewir0bixa" 2024/12/21 02:24:39 DEBUG : Swift container crypt path rclone-test-bobewir0bixa: Auto set use_segments_container to true 2024/12/21 02:24:40 DEBUG : Creating backend with remote "/tmp/rclone3679482313" run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-bobewir0bixa'", Local "Local file system at /tmp/rclone3679482313", Modify Window "1ns" 2024/12/21 02:24:40 DEBUG : 測試_Русский___ě_áñ: md5 = b16317bd54565b7eb349dc4de425390f OK NFC checkfile vs. NFD remote (without normalization) 2024/12/21 02:24:40 ERROR : 測試_Русский___ě_áñ: sum not found 2024/12/21 02:24:40 ERROR : 測試_Русский___ě_áñ: file not in Encrypted drive 'TestCryptSwift:rclone-test-bobewir0bixa' 2024/12/21 02:24:40 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-bobewir0bixa': 1 files missing 2024/12/21 02:24:40 NOTICE: 1 hashes missing 2024/12/21 02:24:40 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-bobewir0bixa': 2 differences found 2024/12/21 02:24:40 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-bobewir0bixa': 2 errors while checking NFC checkfile vs. NFD remote (with normalization) 2024/12/21 02:24:40 DEBUG : 測試_Русский___ě_áñ: md5 = 65a8e27d8879283831b664bd8b7f0ad4 OK 2024/12/21 02:24:40 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-bobewir0bixa': 0 differences found 2024/12/21 02:24:40 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-bobewir0bixa': 1 matching files 2024/12/21 02:24:40 DEBUG : Creating backend with remote "TestCryptSwift:rclone-test-kutobep6tede" 2024/12/21 02:24:40 DEBUG : Using config file from "/home/rclone/.rclone.conf" 2024/12/21 02:24:40 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-kutobep6tede.bin" 2024/12/21 02:24:41 DEBUG : Swift container crypt path rclone-test-kutobep6tede.bin: Auto set use_segments_container to true 2024/12/21 02:24:42 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-kutobep6tede" 2024/12/21 02:24:42 DEBUG : Swift container crypt path rclone-test-kutobep6tede: Auto set use_segments_container to true 2024/12/21 02:24:42 DEBUG : Creating backend with remote "/tmp/rclone436776651" run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kutobep6tede'", Local "Local file system at /tmp/rclone436776651", Modify Window "1ns" 2024/12/21 02:24:43 DEBUG : 測試_Русский___ě_áñ測試_Русский___ě_áñ: md5 = 1ec0d7220c38a615d8bbdbb8cb6b78f0 OK NFDx2 checkfile vs. both remote (without normalization) 2024/12/21 02:24:45 ERROR : 測試_Русский___ě_áñ測試_Русский___ě_áñ: sum not found 2024/12/21 02:24:45 ERROR : 測試_Русский___ě_áñ測試_Русский___ě_áñ: file not in Encrypted drive 'TestCryptSwift:rclone-test-kutobep6tede' 2024/12/21 02:24:45 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-kutobep6tede': 1 files missing 2024/12/21 02:24:45 NOTICE: 1 hashes missing 2024/12/21 02:24:45 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-kutobep6tede': 2 differences found 2024/12/21 02:24:45 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-kutobep6tede': 2 errors while checking NFDx2 checkfile vs. both remote (with normalization) 2024/12/21 02:24:45 DEBUG : 測試_Русский___ě_áñ測試_Русский___ě_áñ: md5 = 65a8e27d8879283831b664bd8b7f0ad4 OK 2024/12/21 02:24:45 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-kutobep6tede': 0 differences found 2024/12/21 02:24:45 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-kutobep6tede': 1 matching files 2024/12/21 02:24:45 DEBUG : Creating backend with remote "TestCryptSwift:rclone-test-radovuj2xice" 2024/12/21 02:24:45 DEBUG : Using config file from "/home/rclone/.rclone.conf" 2024/12/21 02:24:45 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-radovuj2xice.bin" 2024/12/21 02:24:46 DEBUG : Swift container crypt path rclone-test-radovuj2xice.bin: Auto set use_segments_container to true 2024/12/21 02:24:46 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-radovuj2xice" 2024/12/21 02:24:47 DEBUG : Swift container crypt path rclone-test-radovuj2xice: Auto set use_segments_container to true 2024/12/21 02:24:47 DEBUG : Creating backend with remote "/tmp/rclone997923908" run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-radovuj2xice'", Local "Local file system at /tmp/rclone997923908", Modify Window "1ns" 2024/12/21 02:24:48 DEBUG : 測試_Русский___ě_áñ測試_Русский___ě_áñ: md5 = f19c1b97de4861359c6e0bd42cf28b83 OK NFCx2 checkfile vs. both remote (without normalization) 2024/12/21 02:24:48 ERROR : 測試_Русский___ě_áñ測試_Русский___ě_áñ: sum not found 2024/12/21 02:24:48 ERROR : 測試_Русский___ě_áñ測試_Русский___ě_áñ: file not in Encrypted drive 'TestCryptSwift:rclone-test-radovuj2xice' 2024/12/21 02:24:48 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-radovuj2xice': 1 files missing 2024/12/21 02:24:48 NOTICE: 1 hashes missing 2024/12/21 02:24:48 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-radovuj2xice': 2 differences found 2024/12/21 02:24:48 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-radovuj2xice': 2 errors while checking NFCx2 checkfile vs. both remote (with normalization) 2024/12/21 02:24:48 DEBUG : 測試_Русский___ě_áñ測試_Русский___ě_áñ: md5 = 65a8e27d8879283831b664bd8b7f0ad4 OK 2024/12/21 02:24:48 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-radovuj2xice': 0 differences found 2024/12/21 02:24:48 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-radovuj2xice': 1 matching files 2024/12/21 02:24:48 DEBUG : Creating backend with remote "TestCryptSwift:rclone-test-nejifoy2hiza" 2024/12/21 02:24:48 DEBUG : Using config file from "/home/rclone/.rclone.conf" 2024/12/21 02:24:48 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-nejifoy2hiza.bin" 2024/12/21 02:24:49 DEBUG : Swift container crypt path rclone-test-nejifoy2hiza.bin: Auto set use_segments_container to true 2024/12/21 02:24:49 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-nejifoy2hiza" 2024/12/21 02:24:50 DEBUG : Swift container crypt path rclone-test-nejifoy2hiza: Auto set use_segments_container to true 2024/12/21 02:24:50 DEBUG : Creating backend with remote "/tmp/rclone3241760840" run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-nejifoy2hiza'", Local "Local file system at /tmp/rclone3241760840", Modify Window "1ns" 2024/12/21 02:24:50 DEBUG : 測試_Русский___ě_áñ測試_Русский___ě_áñ: md5 = e8b1cac1eebf9d9c81fd19726d2d0d76 OK both checkfile vs. NFDx2 remote (without normalization) 2024/12/21 02:24:51 ERROR : 測試_Русский___ě_áñ測試_Русский___ě_áñ: sum not found 2024/12/21 02:24:51 ERROR : 測試_Русский___ě_áñ測試_Русский___ě_áñ: file not in Encrypted drive 'TestCryptSwift:rclone-test-nejifoy2hiza' 2024/12/21 02:24:51 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-nejifoy2hiza': 1 files missing 2024/12/21 02:24:51 NOTICE: 1 hashes missing 2024/12/21 02:24:51 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-nejifoy2hiza': 2 differences found 2024/12/21 02:24:51 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-nejifoy2hiza': 2 errors while checking both checkfile vs. NFDx2 remote (with normalization) 2024/12/21 02:24:51 DEBUG : 測試_Русский___ě_áñ測試_Русский___ě_áñ: md5 = 65a8e27d8879283831b664bd8b7f0ad4 OK 2024/12/21 02:24:51 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-nejifoy2hiza': 0 differences found 2024/12/21 02:24:51 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-nejifoy2hiza': 1 matching files 2024/12/21 02:24:51 DEBUG : Creating backend with remote "TestCryptSwift:rclone-test-gemureh0lute" 2024/12/21 02:24:51 DEBUG : Using config file from "/home/rclone/.rclone.conf" 2024/12/21 02:24:51 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-gemureh0lute.bin" 2024/12/21 02:24:51 DEBUG : Swift container crypt path rclone-test-gemureh0lute.bin: Auto set use_segments_container to true 2024/12/21 02:24:52 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-gemureh0lute" 2024/12/21 02:24:52 DEBUG : Swift container crypt path rclone-test-gemureh0lute: Auto set use_segments_container to true 2024/12/21 02:24:52 DEBUG : Creating backend with remote "/tmp/rclone294836232" run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-gemureh0lute'", Local "Local file system at /tmp/rclone294836232", Modify Window "1ns" 2024/12/21 02:24:53 DEBUG : 測試_Русский___ě_áñ測試_Русский___ě_áñ: md5 = f4a7a1baeb20f7c5b0df671593470bd8 OK both checkfile vs. NFCx2 remote (without normalization) 2024/12/21 02:24:53 ERROR : 測試_Русский___ě_áñ測試_Русский___ě_áñ: sum not found 2024/12/21 02:24:53 ERROR : 測試_Русский___ě_áñ測試_Русский___ě_áñ: file not in Encrypted drive 'TestCryptSwift:rclone-test-gemureh0lute' 2024/12/21 02:24:53 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-gemureh0lute': 1 files missing 2024/12/21 02:24:53 NOTICE: 1 hashes missing 2024/12/21 02:24:53 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-gemureh0lute': 2 differences found 2024/12/21 02:24:53 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-gemureh0lute': 2 errors while checking both checkfile vs. NFCx2 remote (with normalization) 2024/12/21 02:24:53 DEBUG : 測試_Русский___ě_áñ測試_Русский___ě_áñ: md5 = 65a8e27d8879283831b664bd8b7f0ad4 OK 2024/12/21 02:24:53 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-gemureh0lute': 0 differences found 2024/12/21 02:24:53 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-gemureh0lute': 1 matching files 2024/12/21 02:24:53 DEBUG : Encrypted drive 'TestCryptSwift:rclone-test-gemureh0lute': Purge remote 2024/12/21 02:24:53 DEBUG : Waiting for deletions to finish 2024/12/21 02:24:54 INFO : 測試_Русский___ě_áñ測試_Русский___ě_áñ.bin: Deleted 2024/12/21 02:24:54 DEBUG : Encrypted drive 'TestCryptSwift:rclone-test-nejifoy2hiza': Purge remote 2024/12/21 02:24:54 DEBUG : Waiting for deletions to finish 2024/12/21 02:24:54 INFO : 測試_Русский___ě_áñ測試_Русский___ě_áñ.bin: Deleted 2024/12/21 02:24:54 DEBUG : Encrypted drive 'TestCryptSwift:rclone-test-radovuj2xice': Purge remote 2024/12/21 02:24:54 DEBUG : Waiting for deletions to finish 2024/12/21 02:24:54 INFO : 測試_Русский___ě_áñ測試_Русский___ě_áñ.bin: Deleted 2024/12/21 02:24:54 DEBUG : Encrypted drive 'TestCryptSwift:rclone-test-kutobep6tede': Purge remote 2024/12/21 02:24:54 DEBUG : Waiting for deletions to finish 2024/12/21 02:24:55 INFO : 測試_Русский___ě_áñ測試_Русский___ě_áñ.bin: Deleted 2024/12/21 02:24:55 DEBUG : Encrypted drive 'TestCryptSwift:rclone-test-bobewir0bixa': Purge remote 2024/12/21 02:24:55 DEBUG : Waiting for deletions to finish 2024/12/21 02:24:55 INFO : 測試_Русский___ě_áñ.bin: Deleted 2024/12/21 02:24:55 DEBUG : Encrypted drive 'TestCryptSwift:rclone-test-fonezaw1wini': Purge remote 2024/12/21 02:24:55 DEBUG : Waiting for deletions to finish 2024/12/21 02:24:55 INFO : 測試_Русский___ě_áñ.bin: Deleted 2024/12/21 02:24:55 DEBUG : Encrypted drive 'TestCryptSwift:rclone-test-hogesuh2dazi': Purge remote 2024/12/21 02:24:55 DEBUG : Waiting for deletions to finish 2024/12/21 02:24:56 INFO : HELLO, WORLD!.bin: Deleted 2024/12/21 02:24:56 DEBUG : Encrypted drive 'TestCryptSwift:rclone-test-cocahef1naju': Purge remote 2024/12/21 02:24:56 DEBUG : Waiting for deletions to finish 2024/12/21 02:24:56 INFO : HeLlO, wOrLd!.bin: Deleted 2024/12/21 02:24:56 DEBUG : Encrypted drive 'TestCryptSwift:rclone-test-favuris7pemu': Purge remote 2024/12/21 02:24:56 DEBUG : Waiting for deletions to finish 2024/12/21 02:24:57 INFO : HELLO, WORLD!.bin: Deleted 2024/12/21 02:24:57 DEBUG : Encrypted drive 'TestCryptSwift:rclone-test-yugirim8zubi': Purge remote 2024/12/21 02:24:57 DEBUG : Waiting for deletions to finish 2024/12/21 02:24:57 INFO : hello, world!.bin: Deleted --- PASS: TestApplyTransforms (33.81s) === RUN TestTruncateString --- PASS: TestTruncateString (0.00s) === RUN TestCopyFile run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:24:57 DEBUG : file1: Need to transfer - File not found at Destination 2024/12/21 02:24:57 DEBUG : sub/file2: md5 = f24e045cae20ad098e1d52678d2b1dac OK 2024/12/21 02:24:57 INFO : file1: Copied (new) to: sub/file2 2024/12/21 02:24:58 DEBUG : file1: Size and modification time the same (differ by 0s, within tolerance 1ns) 2024/12/21 02:24:58 DEBUG : file1: Unchanged skipping 2024/12/21 02:24:58 DEBUG : Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli': don't need to copy/move sub/file2, it is already at target location --- PASS: TestCopyFile (1.39s) === RUN TestCopyLongFile run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" copy_test.go:153: Test only runs on local --- SKIP: TestCopyLongFile (0.36s) === RUN TestCopyFileBackupDir run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:24:59 DEBUG : dst/file1: md5 = dcc3bbc4fdc1dc1caa4d031a2173127c OK 2024/12/21 02:24:59 DEBUG : Creating backend with remote "TestCryptSwift:rclone-test-kehimox8xoli/backup" 2024/12/21 02:24:59 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-kehimox8xoli/backup.bin" 2024/12/21 02:25:00 DEBUG : Swift container crypt path rclone-test-kehimox8xoli/backup.bin: Auto set use_segments_container to true 2024/12/21 02:25:00 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-kehimox8xoli/backup" 2024/12/21 02:25:01 DEBUG : Swift container crypt path rclone-test-kehimox8xoli/backup: Auto set use_segments_container to true 2024/12/21 02:25:01 DEBUG : dst/file1: Sizes differ (src 14 vs dst 18) 2024/12/21 02:25:02 INFO : dst/file1: Copied (server-side copy) 2024/12/21 02:25:02 INFO : dst/file1: Deleted 2024/12/21 02:25:02 DEBUG : dst/file1: md5 = b805b91fd8d28b8b69cd73e295f32e82 OK 2024/12/21 02:25:02 INFO : dst/file1: Copied (new) --- PASS: TestCopyFileBackupDir (4.50s) === RUN TestCopyFileCompareDest run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:25:03 DEBUG : Creating backend with remote "TestCryptSwift:rclone-test-kehimox8xoli/dst" 2024/12/21 02:25:03 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-kehimox8xoli/dst.bin" 2024/12/21 02:25:04 DEBUG : Swift container crypt path rclone-test-kehimox8xoli/dst.bin: Auto set use_segments_container to true 2024/12/21 02:25:04 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-kehimox8xoli/dst" 2024/12/21 02:25:05 DEBUG : Swift container crypt path rclone-test-kehimox8xoli/dst: Auto set use_segments_container to true 2024/12/21 02:25:05 DEBUG : Creating backend with remote "TestCryptSwift:rclone-test-kehimox8xoli/CompareDest" 2024/12/21 02:25:05 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-kehimox8xoli/CompareDest.bin" 2024/12/21 02:25:06 DEBUG : Swift container crypt path rclone-test-kehimox8xoli/CompareDest.bin: Auto set use_segments_container to true 2024/12/21 02:25:06 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-kehimox8xoli/CompareDest" 2024/12/21 02:25:06 DEBUG : Swift container crypt path rclone-test-kehimox8xoli/CompareDest: Auto set use_segments_container to true 2024/12/21 02:25:07 DEBUG : one: Need to transfer - File not found at Destination 2024/12/21 02:25:07 DEBUG : one: md5 = c20c1a7cc0bc6e05ed6d9512269b0f7a OK 2024/12/21 02:25:07 INFO : one: Copied (new) 2024/12/21 02:25:08 DEBUG : one: Sizes differ (src 5 vs dst 3) 2024/12/21 02:25:08 DEBUG : one: md5 = 0e633a533e4a0bf9a61f1206b031b422 OK 2024/12/21 02:25:08 INFO : one: Copied (replaced existing) 2024/12/21 02:25:09 DEBUG : dst/one: md5 = 1112f2486b2c9716de84e0b888802549 OK 2024/12/21 02:25:09 DEBUG : CompareDest/one: md5 = 99a5ec87372c829c39ec847016cd2840 OK 2024/12/21 02:25:09 DEBUG : one: Sizes differ (src 5 vs dst 3) 2024/12/21 02:25:09 DEBUG : one: Size and modification time the same (differ by 0s, within tolerance 1ns) 2024/12/21 02:25:09 DEBUG : one: Destination found in --compare-dest, skipping 2024/12/21 02:25:10 DEBUG : CompareDest/two: md5 = 878c42907d26933406f919b60ee4bbfe OK 2024/12/21 02:25:10 DEBUG : two: Need to transfer - File not found at Destination 2024/12/21 02:25:10 DEBUG : two: Size and modification time the same (differ by 0s, within tolerance 1ns) 2024/12/21 02:25:10 DEBUG : two: Destination found in --compare-dest, skipping 2024/12/21 02:25:11 DEBUG : two: Need to transfer - File not found at Destination 2024/12/21 02:25:11 DEBUG : two: Size and modification time the same (differ by 0s, within tolerance 1ns) 2024/12/21 02:25:11 DEBUG : two: Destination found in --compare-dest, skipping 2024/12/21 02:25:11 DEBUG : two: Need to transfer - File not found at Destination 2024/12/21 02:25:11 DEBUG : two: Sizes differ (src 5 vs dst 3) 2024/12/21 02:25:12 DEBUG : two: md5 = 1ab53a72647d915e5288e4055506680f OK 2024/12/21 02:25:12 INFO : two: Copied (new) --- PASS: TestCopyFileCompareDest (10.06s) === RUN TestCopyFileCopyDest run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:25:13 DEBUG : Creating backend with remote "TestCryptSwift:rclone-test-kehimox8xoli/dst" 2024/12/21 02:25:13 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-kehimox8xoli/dst.bin" 2024/12/21 02:25:14 DEBUG : Swift container crypt path rclone-test-kehimox8xoli/dst.bin: Auto set use_segments_container to true 2024/12/21 02:25:14 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-kehimox8xoli/dst" 2024/12/21 02:25:14 DEBUG : Swift container crypt path rclone-test-kehimox8xoli/dst: Auto set use_segments_container to true 2024/12/21 02:25:15 DEBUG : Creating backend with remote "TestCryptSwift:rclone-test-kehimox8xoli/CopyDest" 2024/12/21 02:25:15 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-kehimox8xoli/CopyDest.bin" 2024/12/21 02:25:15 DEBUG : Swift container crypt path rclone-test-kehimox8xoli/CopyDest.bin: Auto set use_segments_container to true 2024/12/21 02:25:16 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-kehimox8xoli/CopyDest" 2024/12/21 02:25:16 DEBUG : Swift container crypt path rclone-test-kehimox8xoli/CopyDest: Auto set use_segments_container to true 2024/12/21 02:25:16 DEBUG : one: Need to transfer - File not found at Destination 2024/12/21 02:25:17 DEBUG : one: md5 = 163ada953c313aacab6a5150d18d81cc OK 2024/12/21 02:25:17 INFO : one: Copied (new) 2024/12/21 02:25:17 DEBUG : one: Sizes differ (src 5 vs dst 3) 2024/12/21 02:25:18 DEBUG : one: md5 = 68a6fed619022ebcc39212a79280a63b OK 2024/12/21 02:25:18 INFO : one: Copied (replaced existing) 2024/12/21 02:25:18 DEBUG : dst/one: md5 = ffcb1f034a2845bf40ee421f2df41a23 OK 2024/12/21 02:25:19 DEBUG : CopyDest/one: md5 = bb16d0688de3d9252b0e7891c3a22ac9 OK 2024/12/21 02:25:19 DEBUG : Creating backend with remote "TestCryptSwift:rclone-test-kehimox8xoli/BackupDir" 2024/12/21 02:25:19 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-kehimox8xoli/BackupDir.bin" 2024/12/21 02:25:19 DEBUG : Swift container crypt path rclone-test-kehimox8xoli/BackupDir.bin: Auto set use_segments_container to true 2024/12/21 02:25:20 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-kehimox8xoli/BackupDir" 2024/12/21 02:25:20 DEBUG : Swift container crypt path rclone-test-kehimox8xoli/BackupDir: Auto set use_segments_container to true 2024/12/21 02:25:21 DEBUG : one: Sizes differ (src 5 vs dst 3) 2024/12/21 02:25:21 DEBUG : one: Size and modification time the same (differ by 0s, within tolerance 1ns) 2024/12/21 02:25:21 DEBUG : one: Sizes differ (src 5 vs dst 3) 2024/12/21 02:25:21 INFO : one: Copied (server-side copy) 2024/12/21 02:25:22 INFO : one: Deleted 2024/12/21 02:25:22 INFO : one: Copied (server-side copy) 2024/12/21 02:25:22 DEBUG : one: Destination found in --copy-dest, using server-side copy 2024/12/21 02:25:22 DEBUG : CopyDest/two: md5 = 697f4de1623fdfd3ce4ada931fa91cee OK 2024/12/21 02:25:23 DEBUG : two: Need to transfer - File not found at Destination 2024/12/21 02:25:23 DEBUG : two: Size and modification time the same (differ by 0s, within tolerance 1ns) 2024/12/21 02:25:23 INFO : two: Copied (server-side copy) 2024/12/21 02:25:23 DEBUG : two: Destination found in --copy-dest, using server-side copy 2024/12/21 02:25:24 DEBUG : two: Size and modification time the same (differ by 0s, within tolerance 1ns) 2024/12/21 02:25:24 DEBUG : two: Unchanged skipping 2024/12/21 02:25:24 DEBUG : CopyDest/three: md5 = a08d439dea28c1a0b55f721324b02e6f OK 2024/12/21 02:25:25 DEBUG : three: Need to transfer - File not found at Destination 2024/12/21 02:25:25 DEBUG : three: Sizes differ (src 7 vs dst 5) 2024/12/21 02:25:25 DEBUG : three: Destination not found in --copy-dest 2024/12/21 02:25:25 DEBUG : three: md5 = 1a28def4aed4a52d97b1e3666db44069 OK 2024/12/21 02:25:25 INFO : three: Copied (new) --- PASS: TestCopyFileCopyDest (14.40s) === RUN TestCopyInplace run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" copy_test.go:370: Partial uploads not supported --- SKIP: TestCopyInplace (0.57s) === RUN TestCopyLongFileName run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" copy_test.go:403: Partial uploads not supported --- SKIP: TestCopyLongFileName (0.28s) === RUN TestCopyFileMaxTransfer run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:25:29 DEBUG : TestCopyFileMaxTransfer/file1: Need to transfer - File not found at Destination 2024/12/21 02:25:29 DEBUG : TestCopyFileMaxTransfer/file1: md5 = b06b17c08e93fdf09140ab003ff89a4c OK 2024/12/21 02:25:29 INFO : TestCopyFileMaxTransfer/file1: Copied (new) 2024/12/21 02:25:30 DEBUG : TestCopyFileMaxTransfer/file2: Need to transfer - File not found at Destination 2024/12/21 02:25:30 ERROR : TestCopyFileMaxTransfer/file2: Failed to copy: Put "https://csproxy5.memset.com/v1/AUTH_msnickcaa1_93fd688179b54bb5aa9604bf21f236be/crypt/rclone-test-kehimox8xoli/TestCopyFileMaxTransfer/file2.bin": max transfer limit reached as set by --max-transfer 2024/12/21 02:25:30 DEBUG : TestCopyFileMaxTransfer/file3: Need to transfer - File not found at Destination 2024/12/21 02:25:31 DEBUG : TestCopyFileMaxTransfer/file4: Need to transfer - File not found at Destination 2024/12/21 02:25:31 DEBUG : TestCopyFileMaxTransfer/file4: md5 = 23cd0b5c839942784b6fc5c18f0f991e OK 2024/12/21 02:25:31 INFO : TestCopyFileMaxTransfer/file4: Copied (new) --- PASS: TestCopyFileMaxTransfer (4.00s) === RUN TestDeduplicateInteractive run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" dedupe_test.go:24: Can't test deduplicate - no duplicate files possible --- SKIP: TestDeduplicateInteractive (0.18s) === RUN TestDeduplicateSkip run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" dedupe_test.go:24: Can't test deduplicate - no duplicate files possible --- SKIP: TestDeduplicateSkip (0.73s) === RUN TestDeduplicateSizeOnly run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" dedupe_test.go:24: Can't test deduplicate - no duplicate files possible --- SKIP: TestDeduplicateSizeOnly (0.10s) === RUN TestDeduplicateFirst run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" dedupe_test.go:24: Can't test deduplicate - no duplicate files possible --- SKIP: TestDeduplicateFirst (0.10s) === RUN TestDeduplicateNewest run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" dedupe_test.go:24: Can't test deduplicate - no duplicate files possible --- SKIP: TestDeduplicateNewest (0.10s) === RUN TestDeduplicateNewestByHash run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" dedupe_test.go:36: Can't run this test without a hash --- SKIP: TestDeduplicateNewestByHash (0.16s) === RUN TestDeduplicateOldest run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" dedupe_test.go:24: Can't test deduplicate - no duplicate files possible --- SKIP: TestDeduplicateOldest (0.20s) === RUN TestDeduplicateLargest run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" dedupe_test.go:24: Can't test deduplicate - no duplicate files possible --- SKIP: TestDeduplicateLargest (0.20s) === RUN TestDeduplicateSmallest run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" dedupe_test.go:24: Can't test deduplicate - no duplicate files possible --- SKIP: TestDeduplicateSmallest (0.20s) === RUN TestDeduplicateRename run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" dedupe_test.go:24: Can't test deduplicate - no duplicate files possible --- SKIP: TestDeduplicateRename (0.40s) === RUN TestMergeDirs run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" dedupe_test.go:256: Can't merge directories --- SKIP: TestMergeDirs (0.40s) === RUN TestListDirSorted run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:25:35 DEBUG : a.txt: md5 = 4c1d4ecc0f16d5d7401bf24e93414107 OK 2024/12/21 02:25:36 DEBUG : zend.txt: md5 = 687a2800138a77ffb1d1682f3cd1cd64 OK 2024/12/21 02:25:37 DEBUG : sub dir/hello world: md5 = 94df05b14f8d0b8c473d485084aa640c OK 2024/12/21 02:25:38 DEBUG : sub dir/hello world2: md5 = 780ff6e593306c670650c7d25add3000 OK 2024/12/21 02:25:38 DEBUG : sub dir/ignore dir/.ignore: md5 = 5389d60ef9c75af257136658b787b630 OK 2024/12/21 02:25:38 DEBUG : sub dir/ignore dir/should be ignored: md5 = ec00be2f8289cf375cce1c9d4bad6ffe OK 2024/12/21 02:25:39 DEBUG : sub dir/sub sub dir/hello world3: md5 = 9fe68f60b6f1ad974511b14648af9161 OK 2024/12/21 02:25:40 DEBUG : a.txt: Excluded (Size Filter) 2024/12/21 02:25:40 DEBUG : a.txt: Excluded 2024/12/21 02:25:40 DEBUG : sub dir/hello world: Excluded (Size Filter) 2024/12/21 02:25:40 DEBUG : sub dir/hello world: Excluded 2024/12/21 02:25:40 DEBUG : sub dir/hello world2: Excluded (Size Filter) 2024/12/21 02:25:40 DEBUG : sub dir/hello world2: Excluded 2024/12/21 02:25:40 DEBUG : sub dir/hello world: Excluded (Size Filter) 2024/12/21 02:25:40 DEBUG : sub dir/hello world: Excluded 2024/12/21 02:25:40 DEBUG : sub dir/hello world2: Excluded (Size Filter) 2024/12/21 02:25:40 DEBUG : sub dir/hello world2: Excluded 2024/12/21 02:25:40 DEBUG : sub dir/ignore dir: Excluded 2024/12/21 02:25:40 DEBUG : sub dir/ignore dir: Excluded --- PASS: TestListDirSorted (7.57s) === RUN TestListJSON run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:25:43 DEBUG : file1: md5 = 6781bd7ae04ebc1a7da405bf5617ed7e OK 2024/12/21 02:25:43 DEBUG : sub/file2: md5 = 3d3aca32240336712c90fd77f8dca3ac OK === RUN TestListJSON/Default === RUN TestListJSON/FilesOnly === RUN TestListJSON/DirsOnly === RUN TestListJSON/Recurse === RUN TestListJSON/SubDir === RUN TestListJSON/NoModTime === RUN TestListJSON/NoMimeType === RUN TestListJSON/ShowHash === RUN TestListJSON/HashTypes 2024/12/21 02:25:45 ERROR : file1: Failed to read hash: hash type not supported === RUN TestListJSON/Metadata --- PASS: TestListJSON (2.52s) --- PASS: TestListJSON/Default (0.22s) --- PASS: TestListJSON/FilesOnly (0.09s) --- PASS: TestListJSON/DirsOnly (0.05s) --- PASS: TestListJSON/Recurse (0.14s) --- PASS: TestListJSON/SubDir (0.18s) --- PASS: TestListJSON/NoModTime (0.05s) --- PASS: TestListJSON/NoMimeType (0.09s) --- PASS: TestListJSON/ShowHash (0.09s) --- PASS: TestListJSON/HashTypes (0.09s) --- PASS: TestListJSON/Metadata (0.27s) === RUN TestStatJSON run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:25:45 DEBUG : file1: md5 = 289086499318505e7a0849a6c203b787 OK 2024/12/21 02:25:46 DEBUG : sub/file2: md5 = aae71e0448195d84e119ab426157e9ee OK === RUN TestStatJSON/Root === RUN TestStatJSON/RootFilesOnly === RUN TestStatJSON/RootDirsOnly === RUN TestStatJSON/Dir === RUN TestStatJSON/DirWithTrailingSlash === RUN TestStatJSON/File === RUN TestStatJSON/NotFound === RUN TestStatJSON/DirFilesOnly === RUN TestStatJSON/FileFilesOnly === RUN TestStatJSON/NotFoundFilesOnly === RUN TestStatJSON/DirDirsOnly === RUN TestStatJSON/FileDirsOnly === RUN TestStatJSON/NotFoundDirsOnly === RUN TestStatJSON/RootNotFound 2024/12/21 02:25:48 DEBUG : Creating backend with remote "TestCryptSwift:rclone-test-kehimox8xoli/notfound" 2024/12/21 02:25:48 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-kehimox8xoli/notfound.bin" 2024/12/21 02:25:48 DEBUG : Swift container crypt path rclone-test-kehimox8xoli/notfound.bin: Auto set use_segments_container to true 2024/12/21 02:25:48 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-kehimox8xoli/notfound" 2024/12/21 02:25:49 DEBUG : Swift container crypt path rclone-test-kehimox8xoli/notfound: Auto set use_segments_container to true --- PASS: TestStatJSON (4.71s) --- PASS: TestStatJSON/Root (0.14s) --- PASS: TestStatJSON/RootFilesOnly (0.00s) --- PASS: TestStatJSON/RootDirsOnly (0.05s) --- PASS: TestStatJSON/Dir (0.36s) --- PASS: TestStatJSON/DirWithTrailingSlash (0.14s) --- PASS: TestStatJSON/File (0.05s) --- PASS: TestStatJSON/NotFound (0.40s) --- PASS: TestStatJSON/DirFilesOnly (0.05s) --- PASS: TestStatJSON/FileFilesOnly (0.05s) --- PASS: TestStatJSON/NotFoundFilesOnly (0.06s) --- PASS: TestStatJSON/DirDirsOnly (0.05s) --- PASS: TestStatJSON/FileDirsOnly (0.13s) --- PASS: TestStatJSON/NotFoundDirsOnly (0.15s) --- PASS: TestStatJSON/RootNotFound (1.71s) === RUN TestMkdir run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:25:50 DEBUG : Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli': Making directory 2024/12/21 02:25:50 DEBUG : Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli': Making directory --- PASS: TestMkdir (0.74s) === RUN TestLsd run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:25:51 DEBUG : sub dir/hello world: md5 = f1a508dc9b093e36950afaf295aa4c0f OK --- PASS: TestLsd (2.18s) === RUN TestLs run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:25:53 DEBUG : potato2: md5 = cda6efe6d0dcb53915b9b053087226d3 OK 2024/12/21 02:25:54 DEBUG : empty space: md5 = 0de882d827bd3907294f908ed3171a24 OK --- PASS: TestLs (2.08s) === RUN TestLsWithFilesFrom run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:25:55 DEBUG : potato2: md5 = 76e3f486321c63190dc415f7a935fde3 OK 2024/12/21 02:25:56 DEBUG : empty space: md5 = 8eeec14d18981882cfc577054059aaaa OK 2024/12/21 02:25:57 DEBUG : empty space: Excluded (FilesFrom Filter) 2024/12/21 02:25:57 DEBUG : empty space: Excluded --- PASS: TestLsWithFilesFrom (2.96s) === RUN TestLsLong run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:25:58 DEBUG : potato2: md5 = 5e743f379c76a00539af79f1b070c8c1 OK 2024/12/21 02:25:58 DEBUG : empty space: md5 = f2248c04ab916295293c7f9f797345b0 OK --- PASS: TestLsLong (1.51s) === RUN TestHashSums run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:26:00 DEBUG : potato2: md5 = bec9f4a0ab1dc71559b0220e30f6391d OK 2024/12/21 02:26:00 DEBUG : empty space: md5 = 9a0edadcb63868735a36ec8580034069 OK --- PASS: TestHashSums (1.85s) === RUN TestHashSumsWithErrors 2024/12/21 02:26:01 DEBUG : Creating backend with remote ":memory:" 2024/12/21 02:26:01 ERROR : file1: hash unsupported: hash type not supported --- PASS: TestHashSumsWithErrors (0.00s) === RUN TestHashStream 2024/12/21 02:26:01 DEBUG : Creating md5 hash of 0 bytes read from input stream 2024/12/21 02:26:01 DEBUG : Creating md5 hash of 0 bytes read from input stream 2024/12/21 02:26:01 DEBUG : Creating sha1 hash of 0 bytes read from input stream 2024/12/21 02:26:01 DEBUG : Creating sha1 hash of 0 bytes read from input stream 2024/12/21 02:26:01 DEBUG : Creating md5 hash of 12 bytes read from input stream 2024/12/21 02:26:01 DEBUG : Creating md5 hash of 12 bytes read from input stream 2024/12/21 02:26:01 DEBUG : Creating sha1 hash of 12 bytes read from input stream 2024/12/21 02:26:01 DEBUG : Creating sha1 hash of 12 bytes read from input stream --- PASS: TestHashStream (0.00s) === RUN TestSuffixName --- PASS: TestSuffixName (0.00s) === RUN TestCount run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:26:01 DEBUG : potato2: md5 = 1ec0a3ef77aa5a7998e532f90b0d045b OK 2024/12/21 02:26:02 DEBUG : empty space: md5 = bd9b16c5021d52429d2b24f6937f7b5a OK 2024/12/21 02:26:02 DEBUG : sub dir/potato3: md5 = 6449b6844d691626fd8e7f9591204977 OK --- PASS: TestCount (1.87s) === RUN TestDelete run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:26:04 DEBUG : small: md5 = 58504830a733a72368c48d39135ca29e OK 2024/12/21 02:26:05 DEBUG : medium: md5 = 38842cd494f008d8e28d3cdfa55ea21d OK 2024/12/21 02:26:05 DEBUG : large: md5 = ceed64af3938e5602bdd5547bb52b5f5 OK 2024/12/21 02:26:05 DEBUG : Waiting for deletions to finish 2024/12/21 02:26:05 DEBUG : large: Excluded (Size Filter) 2024/12/21 02:26:05 INFO : small: Deleted 2024/12/21 02:26:06 INFO : medium: Deleted --- PASS: TestDelete (3.47s) === RUN TestMaxDelete run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:26:07 DEBUG : small: md5 = 64835a4a7a5b36072f45eea7727a1a9a OK 2024/12/21 02:26:07 DEBUG : medium: md5 = 0cef69c0779dab1311d9b0e2c5aad6fd OK 2024/12/21 02:26:07 DEBUG : large: md5 = 6474b160bf33efb71ddd1f2b2aa664b6 OK 2024/12/21 02:26:08 DEBUG : Waiting for deletions to finish 2024/12/21 02:26:08 ERROR : small: Got fatal error on delete: --max-delete threshold reached 2024/12/21 02:26:08 INFO : large: Deleted 2024/12/21 02:26:08 INFO : medium: Deleted --- PASS: TestMaxDelete (2.08s) === RUN TestMaxDeleteSizeLargeFile run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:26:09 DEBUG : small: md5 = f3d3b8d8bbc7cff1b665fee5e4913ed7 OK 2024/12/21 02:26:09 DEBUG : medium: md5 = b5a78a6f4623f272ae8ca09791766ad3 OK 2024/12/21 02:26:09 DEBUG : large: md5 = 7004416e4250012a3a9aef16d6a56fde OK 2024/12/21 02:26:10 DEBUG : Waiting for deletions to finish 2024/12/21 02:26:10 ERROR : large: Got fatal error on delete: --max-delete-size threshold reached 2024/12/21 02:26:10 INFO : small: Deleted 2024/12/21 02:26:10 INFO : medium: Deleted --- PASS: TestMaxDeleteSizeLargeFile (2.37s) === RUN TestMaxDeleteSize run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:26:11 DEBUG : small: md5 = dd0b2b7cf07b878f0c8b307a1251c7d6 OK 2024/12/21 02:26:12 DEBUG : medium: md5 = 835fa1a902294a42233072a89d94be53 OK 2024/12/21 02:26:12 DEBUG : large: md5 = f33896882c3ca4417c6f4a2ca5947e92 OK 2024/12/21 02:26:12 DEBUG : Waiting for deletions to finish 2024/12/21 02:26:12 ERROR : small: Got fatal error on delete: --max-delete-size threshold reached 2024/12/21 02:26:12 INFO : large: Deleted 2024/12/21 02:26:12 INFO : medium: Deleted --- PASS: TestMaxDeleteSize (2.83s) === RUN TestReadFile run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:26:15 DEBUG : ReadFile: md5 = 0d9fe57fae7da176db3257c03f8ced87 OK --- PASS: TestReadFile (1.91s) === RUN TestRetry 2024/12/21 02:26:16 DEBUG : Received error: Wrapped EOF is retriable: EOF - low level retry 1/5 2024/12/21 02:26:16 DEBUG : Received error: Wrapped EOF is retriable: EOF - low level retry 2/5 2024/12/21 02:26:16 DEBUG : Sleeping for 10ms (as indicated by the server) to obey Retry-After error: BANG 2024/12/21 02:26:16 DEBUG : Sleeping for 10ms (as indicated by the server) to obey Retry-After error: BANG 2024/12/21 02:26:16 DEBUG : Sleeping for 10ms (as indicated by the server) to obey Retry-After error: BANG 2024/12/21 02:26:16 DEBUG : Sleeping for 10ms (as indicated by the server) to obey Retry-After error: BANG 2024/12/21 02:26:16 DEBUG : Sleeping for 10ms (as indicated by the server) to obey Retry-After error: BANG --- PASS: TestRetry (0.05s) === RUN TestCat run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:26:16 DEBUG : file1: md5 = 21fb8db2da952be30f550cb190ffb402 OK 2024/12/21 02:26:17 DEBUG : file2: md5 = ffe639ce3327ae65e251eadfda6c594c OK --- PASS: TestCat (3.47s) === RUN TestPurge 2024/12/21 02:26:19 DEBUG : Creating backend with remote "TestCryptSwift:rclone-test-waxunug6caje" 2024/12/21 02:26:19 DEBUG : Using config file from "/home/rclone/.rclone.conf" 2024/12/21 02:26:19 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-waxunug6caje.bin" 2024/12/21 02:26:20 DEBUG : Swift container crypt path rclone-test-waxunug6caje.bin: Auto set use_segments_container to true 2024/12/21 02:26:21 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-waxunug6caje" 2024/12/21 02:26:21 DEBUG : Swift container crypt path rclone-test-waxunug6caje: Auto set use_segments_container to true 2024/12/21 02:26:21 DEBUG : Creating backend with remote "/tmp/rclone564812262" run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-waxunug6caje'", Local "Local file system at /tmp/rclone564812262", Modify Window "1ns" 2024/12/21 02:26:22 DEBUG : A1/B1/C1/one: md5 = 3d932f608af224bf789151cf4005a02a OK 2024/12/21 02:26:22 DEBUG : A2: Making directory 2024/12/21 02:26:22 DEBUG : A1/B2: Making directory 2024/12/21 02:26:22 DEBUG : A1/B2/C2: Making directory 2024/12/21 02:26:22 DEBUG : A1/B1/C3: Making directory 2024/12/21 02:26:22 DEBUG : A3: Making directory 2024/12/21 02:26:22 DEBUG : A3/B3: Making directory 2024/12/21 02:26:22 DEBUG : A3/B3/C4: Making directory 2024/12/21 02:26:23 DEBUG : A1/two: md5 = 319aa982f1d8a226b5f7f6b3facc4f90 OK fstest.go:244: Filtering empty directory "A2" fstest.go:244: Filtering empty directory "A1/B2" fstest.go:244: Filtering empty directory "A1/B2/C2" fstest.go:244: Filtering empty directory "A1/B1/C3" fstest.go:244: Filtering empty directory "A3" fstest.go:244: Filtering empty directory "A3/B3" fstest.go:244: Filtering empty directory "A3/B3/C4" 2024/12/21 02:26:23 DEBUG : Waiting for deletions to finish 2024/12/21 02:26:23 INFO : A1/B1/C1/one.bin: Deleted fstest.go:244: Filtering empty directory "A2" fstest.go:244: Filtering empty directory "A1/B2" fstest.go:244: Filtering empty directory "A1/B2/C2" fstest.go:244: Filtering empty directory "A3" fstest.go:244: Filtering empty directory "A3/B3" fstest.go:244: Filtering empty directory "A3/B3/C4" 2024/12/21 02:26:24 DEBUG : Waiting for deletions to finish 2024/12/21 02:26:24 INFO : A1/two.bin: Deleted 2024/12/21 02:26:24 DEBUG : Encrypted drive 'TestCryptSwift:rclone-test-waxunug6caje': Purge remote 2024/12/21 02:26:24 DEBUG : Waiting for deletions to finish --- PASS: TestPurge (4.60s) === RUN TestRmdirsNoLeaveRoot run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:26:25 DEBUG : A1/B1/C1/one: md5 = 5cc0acc4dd977195b609259e8bec2ac1 OK 2024/12/21 02:26:25 DEBUG : A2: Making directory 2024/12/21 02:26:25 DEBUG : A1/B2: Making directory 2024/12/21 02:26:25 DEBUG : A1/B2/C2: Making directory 2024/12/21 02:26:25 DEBUG : A1/B1/C3: Making directory 2024/12/21 02:26:25 DEBUG : A3: Making directory 2024/12/21 02:26:25 DEBUG : A3/B3: Making directory 2024/12/21 02:26:25 DEBUG : A3/B3/C4: Making directory 2024/12/21 02:26:25 DEBUG : A1/two: md5 = c1648532b96ee37e27625db1d66d5aa4 OK fstest.go:244: Filtering empty directory "A2" fstest.go:244: Filtering empty directory "A1/B2" fstest.go:244: Filtering empty directory "A1/B2/C2" fstest.go:244: Filtering empty directory "A1/B1/C3" fstest.go:244: Filtering empty directory "A3" fstest.go:244: Filtering empty directory "A3/B3" fstest.go:244: Filtering empty directory "A3/B3/C4" 2024/12/21 02:26:26 DEBUG : removing 1 level 3 directories 2024/12/21 02:26:26 INFO : A3/B3/C4: Removing directory fstest.go:244: Filtering empty directory "A2" fstest.go:244: Filtering empty directory "A1/B2" fstest.go:244: Filtering empty directory "A1/B2/C2" fstest.go:244: Filtering empty directory "A1/B1/C3" fstest.go:244: Filtering empty directory "A3" fstest.go:244: Filtering empty directory "A3/B3" 2024/12/21 02:26:27 DEBUG : removing 1 level 0 directories 2024/12/21 02:26:27 INFO : Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli': Removing directory --- PASS: TestRmdirsNoLeaveRoot (3.24s) === RUN TestRmdirsLeaveRoot run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:26:27 DEBUG : A1: Making directory 2024/12/21 02:26:27 DEBUG : A1/B1: Making directory 2024/12/21 02:26:27 DEBUG : A1/B1/C1: Making directory fstest.go:244: Filtering empty directory "A1" fstest.go:244: Filtering empty directory "A1/B1" fstest.go:244: Filtering empty directory "A1/B1/C1" fstest.go:244: Filtering empty directory "A1" --- PASS: TestRmdirsLeaveRoot (0.55s) === RUN TestRmdirsWithFilter run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:26:28 DEBUG : A1: Making directory 2024/12/21 02:26:28 DEBUG : A1/B1: Making directory 2024/12/21 02:26:28 DEBUG : A1/B1/C1: Making directory fstest.go:244: Filtering empty directory "A1" fstest.go:244: Filtering empty directory "A1/B1" fstest.go:244: Filtering empty directory "A1/B1/C1" fstest.go:244: Filtering empty directory "A1" --- PASS: TestRmdirsWithFilter (0.41s) === RUN TestCopyURL run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:26:28 DEBUG : file1: md5 = da369609c08c41fbd6f1f044857a685c OK 2024/12/21 02:26:29 DEBUG : filename.txt: File name found in url 2024/12/21 02:26:29 DEBUG : filename.txt: md5 = 5025798c1b07c1cdf6c2ddbe8ef39cc7 OK 2024/12/21 02:26:29 DEBUG : headerfilename.txt: filename found in Content-Disposition header. 2024/12/21 02:26:29 DEBUG : headerfilename.txt: md5 = a778b0f315c46179997141a2a935c2c1 OK 2024/12/21 02:26:30 DEBUG : file2: md5 = b7c961ebe9f0d23a786a1a4f4bdceadd OK --- PASS: TestCopyURL (2.61s) === RUN TestCopyURLToWriter --- PASS: TestCopyURLToWriter (0.00s) === RUN TestMoveFile run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:26:31 DEBUG : file1: Need to transfer - File not found at Destination 2024/12/21 02:26:31 DEBUG : sub/file2: md5 = 9f8b6b5e4bb00f6bba9f7c6b70570ef9 OK 2024/12/21 02:26:31 INFO : file1: Copied (new) to: sub/file2 2024/12/21 02:26:31 INFO : file1: Deleted 2024/12/21 02:26:32 DEBUG : file1: Size and modification time the same (differ by 0s, within tolerance 1ns) 2024/12/21 02:26:32 DEBUG : file1: Unchanged skipping 2024/12/21 02:26:32 INFO : file1: Deleted 2024/12/21 02:26:32 DEBUG : Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli': don't need to copy/move sub/file2, it is already at target location --- PASS: TestMoveFile (1.40s) === RUN TestMoveFileWithIgnoreExisting run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:26:32 DEBUG : file1: Need to transfer - File not found at Destination 2024/12/21 02:26:32 DEBUG : file1: md5 = 426bac86df7134d5850f0004ddda161a OK 2024/12/21 02:26:32 INFO : file1: Copied (new) 2024/12/21 02:26:32 INFO : file1: Deleted 2024/12/21 02:26:33 DEBUG : file1: Destination exists, skipping 2024/12/21 02:26:33 DEBUG : file1: Not removing source file as destination file exists and --ignore-existing is set --- PASS: TestMoveFileWithIgnoreExisting (2.13s) === RUN TestCaseInsensitiveMoveFile run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" --- PASS: TestCaseInsensitiveMoveFile (0.35s) === RUN TestCaseInsensitiveMoveFileDryRun run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" --- PASS: TestCaseInsensitiveMoveFileDryRun (0.10s) === RUN TestMoveFileBackupDir run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:26:35 DEBUG : dst/file1: md5 = 1615440a84895338bc17bd904ad395ba OK 2024/12/21 02:26:35 DEBUG : Creating backend with remote "TestCryptSwift:rclone-test-kehimox8xoli/backup" 2024/12/21 02:26:35 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-kehimox8xoli/backup.bin" 2024/12/21 02:26:36 DEBUG : Swift container crypt path rclone-test-kehimox8xoli/backup.bin: Auto set use_segments_container to true 2024/12/21 02:26:36 DEBUG : Creating backend with remote "memstore:crypt/rclone-test-kehimox8xoli/backup" 2024/12/21 02:26:36 DEBUG : Swift container crypt path rclone-test-kehimox8xoli/backup: Auto set use_segments_container to true 2024/12/21 02:26:37 DEBUG : dst/file1: Sizes differ (src 14 vs dst 18) 2024/12/21 02:26:38 INFO : dst/file1: Copied (server-side copy) 2024/12/21 02:26:38 INFO : dst/file1: Deleted 2024/12/21 02:26:38 DEBUG : dst/file1: md5 = 4aae6a5cb74cb0c91a297f600a0e685d OK 2024/12/21 02:26:38 INFO : dst/file1: Copied (new) 2024/12/21 02:26:38 INFO : dst/file1: Deleted --- PASS: TestMoveFileBackupDir (3.90s) === RUN TestSameConfig --- PASS: TestSameConfig (0.00s) === RUN TestSame --- PASS: TestSame (0.00s) === RUN TestOverlappingFilterCheckWithoutFilter --- PASS: TestOverlappingFilterCheckWithoutFilter (0.00s) === RUN TestOverlappingFilterCheckWithFilter --- PASS: TestOverlappingFilterCheckWithFilter (0.00s) === RUN TestListFormat --- PASS: TestListFormat (0.00s) === RUN TestDirMove run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:26:39 DEBUG : A1/one: md5 = 00bc1c605f633d1aa1cc0aec12b85ec0 OK 2024/12/21 02:26:39 DEBUG : A1/two: md5 = 16e3613fe2ea4f4d6d1640138b3b8143 OK 2024/12/21 02:26:41 DEBUG : A1/B1/three: md5 = 167bd9e5047d4f1e46650d275e368c70 OK 2024/12/21 02:26:41 DEBUG : A1/B1/C1/four: md5 = fae848033a46b2eb2449631c90455dea OK 2024/12/21 02:26:42 DEBUG : A1/B1/C2/five: md5 = 9b7a74243fad70faa1cf4ba5917678eb OK 2024/12/21 02:26:42 DEBUG : A1/B2: Making directory 2024/12/21 02:26:42 DEBUG : A1/B1/C3: Making directory fstest.go:244: Filtering empty directory "A1/B2" fstest.go:244: Filtering empty directory "A1/B1/C3" 2024/12/21 02:26:43 INFO : A1/B1/C2/five: Copied (server-side copy) to: A2/B1/C2/five 2024/12/21 02:26:43 INFO : A1/B1/three: Copied (server-side copy) to: A2/B1/three 2024/12/21 02:26:43 INFO : A1/B1/C2/five: Deleted 2024/12/21 02:26:43 INFO : A1/one: Copied (server-side copy) to: A2/one 2024/12/21 02:26:43 INFO : A1/one: Deleted 2024/12/21 02:26:44 INFO : A1/two: Copied (server-side copy) to: A2/two 2024/12/21 02:26:44 INFO : A1/two: Deleted 2024/12/21 02:26:44 INFO : A1/B1/three: Deleted 2024/12/21 02:26:46 INFO : A1/B1/C1/four: Copied (server-side copy) to: A2/B1/C1/four 2024/12/21 02:26:46 INFO : A1/B1/C1/four: Deleted fstest.go:244: Filtering empty directory "A2/B2" fstest.go:244: Filtering empty directory "A2/B1/C3" 2024/12/21 02:26:47 INFO : A2/one: Copied (server-side copy) to: A3/one 2024/12/21 02:26:47 INFO : A2/B1/three: Copied (server-side copy) to: A3/B1/three 2024/12/21 02:26:47 INFO : A2/one: Deleted 2024/12/21 02:26:47 INFO : A2/B1/C1/four: Copied (server-side copy) to: A3/B1/C1/four 2024/12/21 02:26:47 INFO : A2/B1/three: Deleted 2024/12/21 02:26:47 INFO : A2/B1/C2/five: Copied (server-side copy) to: A3/B1/C2/five 2024/12/21 02:26:47 INFO : A2/B1/C2/five: Deleted 2024/12/21 02:26:47 INFO : A2/two: Copied (server-side copy) to: A3/two 2024/12/21 02:26:48 INFO : A2/B1/C1/four: Deleted 2024/12/21 02:26:48 INFO : A2/two: Deleted fstest.go:244: Filtering empty directory "A3/B2" fstest.go:244: Filtering empty directory "A3/B1/C3" 2024/12/21 02:26:48 INFO : Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli': Can't DirMove - falling back to file moves: can't move directory - incompatible remotes 2024/12/21 02:26:49 INFO : A3/B1/C2/five: Copied (server-side copy) to: A4/B1/C2/five 2024/12/21 02:26:49 INFO : A3/B1/three: Copied (server-side copy) to: A4/B1/three 2024/12/21 02:26:49 INFO : A3/one: Copied (server-side copy) to: A4/one 2024/12/21 02:26:49 INFO : A3/B1/C2/five: Deleted 2024/12/21 02:26:49 INFO : A3/B1/three: Deleted 2024/12/21 02:26:49 INFO : A3/one: Deleted 2024/12/21 02:26:49 INFO : A3/two: Copied (server-side copy) to: A4/two 2024/12/21 02:26:49 INFO : A3/two: Deleted 2024/12/21 02:26:50 INFO : A3/B1/C1/four: Copied (server-side copy) to: A4/B1/C1/four 2024/12/21 02:26:50 INFO : A3/B1/C1/four: Deleted fstest.go:244: Filtering empty directory "A4/B2" fstest.go:244: Filtering empty directory "A4/B1/C3" --- PASS: TestDirMove (13.33s) === RUN TestGetFsInfo run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" --- PASS: TestGetFsInfo (0.36s) === RUN TestRcat === RUN TestRcat/withChecksum=false,ignoreChecksum=false run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:26:52 DEBUG : Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli': File to upload is small (34 bytes), uploading instead of streaming 2024/12/21 02:26:53 DEBUG : no_checksum_small_file_from_pipe: md5 = 90c6d3e0c3c04543d57725a080ffb2a4 OK 2024/12/21 02:26:53 NOTICE: Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli': --checksum is in use but the source and destination have no hashes in common; falling back to --size-only 2024/12/21 02:26:53 DEBUG : no_checksum_small_file_from_pipe: Size of src and dst objects identical 2024/12/21 02:26:53 DEBUG : no_checksum_big_file_from_pipe.bin: Uploading segment file "rclone-test-kehimox8xoli/no_checksum_big_file_from_pipe.bin/2024-12-21-022653-Wi7jE9ydI2qmAOaldSqgYQ/00000000" into "crypt_segments" 2024/12/21 02:26:53 DEBUG : no_checksum_big_file_from_pipe.bin: Uploading segments into "crypt_segments" seems done (EOF) 2024/12/21 02:26:53 DEBUG : Swift container crypt path rclone-test-kehimox8xoli: uploading manifest "rclone-test-kehimox8xoli/no_checksum_big_file_from_pipe.bin" to "crypt" 2024/12/21 02:26:54 DEBUG : no_checksum_big_file_from_pipe.bin: Returning empty Md5sum for swift large object 2024/12/21 02:26:54 DEBUG : no_checksum_big_file_from_pipe: Size of src and dst objects identical === RUN TestRcat/withChecksum=true,ignoreChecksum=false run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:26:57 DEBUG : Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli': File to upload is small (34 bytes), uploading instead of streaming 2024/12/21 02:26:58 DEBUG : with_checksum_small_file_from_pipe: md5 = bf24e6adc3c026cc855cbaa00406b79f OK 2024/12/21 02:26:58 DEBUG : with_checksum_small_file_from_pipe: Size of src and dst objects identical 2024/12/21 02:26:58 DEBUG : with_checksum_big_file_from_pipe.bin: Uploading segment file "rclone-test-kehimox8xoli/with_checksum_big_file_from_pipe.bin/2024-12-21-022658-JsdTxxlckEjmWs9nAzNsCA/00000000" into "crypt_segments" 2024/12/21 02:26:58 DEBUG : with_checksum_big_file_from_pipe.bin: Uploading segments into "crypt_segments" seems done (EOF) 2024/12/21 02:26:58 DEBUG : Swift container crypt path rclone-test-kehimox8xoli: uploading manifest "rclone-test-kehimox8xoli/with_checksum_big_file_from_pipe.bin" to "crypt" 2024/12/21 02:26:59 DEBUG : with_checksum_big_file_from_pipe.bin: Returning empty Md5sum for swift large object 2024/12/21 02:26:59 DEBUG : with_checksum_big_file_from_pipe: Size of src and dst objects identical === RUN TestRcat/withChecksum=false,ignoreChecksum=true run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:27:02 DEBUG : Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli': File to upload is small (34 bytes), uploading instead of streaming 2024/12/21 02:27:03 DEBUG : ignore_checksum_small_file_from_pipe: Size and modification time the same (differ by 0s, within tolerance 1ns) 2024/12/21 02:27:03 DEBUG : ignore_checksum_big_file_from_pipe.bin: Uploading segment file "rclone-test-kehimox8xoli/ignore_checksum_big_file_from_pipe.bin/2024-12-21-022703-lHiRO0804HW1AOQdD6lUJA/00000000" into "crypt_segments" 2024/12/21 02:27:04 DEBUG : ignore_checksum_big_file_from_pipe.bin: Uploading segments into "crypt_segments" seems done (EOF) 2024/12/21 02:27:04 DEBUG : Swift container crypt path rclone-test-kehimox8xoli: uploading manifest "rclone-test-kehimox8xoli/ignore_checksum_big_file_from_pipe.bin" to "crypt" 2024/12/21 02:27:04 DEBUG : ignore_checksum_big_file_from_pipe: Size and modification time the same (differ by 0s, within tolerance 1ns) === RUN TestRcat/withChecksum=true,ignoreChecksum=true run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:27:06 DEBUG : Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli': File to upload is small (34 bytes), uploading instead of streaming 2024/12/21 02:27:06 DEBUG : ignore_checksum_small_file_from_pipe: Size of src and dst objects identical 2024/12/21 02:27:06 DEBUG : ignore_checksum_big_file_from_pipe.bin: Uploading segment file "rclone-test-kehimox8xoli/ignore_checksum_big_file_from_pipe.bin/2024-12-21-022706-R9E2ouFjrCCNCTnoZkrFLA/00000000" into "crypt_segments" 2024/12/21 02:27:07 DEBUG : ignore_checksum_big_file_from_pipe.bin: Uploading segments into "crypt_segments" seems done (EOF) 2024/12/21 02:27:07 DEBUG : Swift container crypt path rclone-test-kehimox8xoli: uploading manifest "rclone-test-kehimox8xoli/ignore_checksum_big_file_from_pipe.bin" to "crypt" 2024/12/21 02:27:07 DEBUG : ignore_checksum_big_file_from_pipe: Size of src and dst objects identical --- PASS: TestRcat (16.60s) --- PASS: TestRcat/withChecksum=false,ignoreChecksum=false (4.68s) --- PASS: TestRcat/withChecksum=true,ignoreChecksum=false (5.14s) --- PASS: TestRcat/withChecksum=false,ignoreChecksum=true (3.33s) --- PASS: TestRcat/withChecksum=true,ignoreChecksum=true (3.45s) === RUN TestRcatMetadata run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" operations_test.go:1532: Skipping as destination doesn't support user metadata --- SKIP: TestRcatMetadata (0.60s) === RUN TestRcatSize run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:27:10 DEBUG : potato1: md5 = cd6e21c7a06bdcb9cfff4f9f855fa7ba OK 2024/12/21 02:27:10 DEBUG : Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli': File to upload is small (60 bytes), uploading instead of streaming 2024/12/21 02:27:10 DEBUG : potato2: md5 = 91295b6b493a9a3fa4fbfffd247168d5 OK 2024/12/21 02:27:10 DEBUG : potato2: Size of src and dst objects identical --- PASS: TestRcatSize (1.79s) === RUN TestRcatSizeMetadata run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" operations_test.go:1613: Skipping as destination doesn't support user metadata --- SKIP: TestRcatSizeMetadata (0.33s) === RUN TestTouchDir run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" 2024/12/21 02:27:12 DEBUG : potato2: md5 = 0fe06d3afe809e4be065e0cb9297f8bd OK 2024/12/21 02:27:13 DEBUG : empty space: md5 = b2ac855e631f1ec39436233ed62ca788 OK 2024/12/21 02:27:13 DEBUG : sub dir/potato3: md5 = 1f499335cff1fbdbfc243db9ad0eb314 OK 2024/12/21 02:27:13 DEBUG : Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli': Touching "empty space" 2024/12/21 02:27:14 DEBUG : Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli': Touching "potato2" 2024/12/21 02:27:14 DEBUG : Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli': Touching "sub dir/potato3" --- PASS: TestTouchDir (4.73s) === RUN TestMkdirMetadata run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" operations_test.go:1703: Skipping test as remote does not support MkdirMetadata --- SKIP: TestMkdirMetadata (0.61s) === RUN TestMkdirModTime run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" operations_test.go:1722: Skipping test as remote does not support DirSetModTime or MkdirMetadata --- SKIP: TestMkdirModTime (0.32s) === RUN TestCopyDirMetadata run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" operations_test.go:1743: Skipping test as remote does not support WriteDirMetadata or MkdirMetadata --- SKIP: TestCopyDirMetadata (0.38s) === RUN TestSetDirModTime run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" operations_test.go:1779: Skipping test as remote does not support DirSetModTime or WriteDirSetModTime --- SKIP: TestSetDirModTime (0.10s) === RUN TestDirsEqual run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" operations_test.go:1823: Skipping test as remote does not support WriteDirMetadata or MkdirMetadata --- SKIP: TestDirsEqual (0.21s) === RUN TestRemoveExisting run.go:180: Remote "Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli'", Local "Local file system at /tmp/rclone4162388848", Modify Window "1ns" operations_test.go:1892: Skipping as remote can't Move --- SKIP: TestRemoveExisting (0.47s) === RUN TestRcAbout rc_test.go:30: Skipping test on non local remote --- SKIP: TestRcAbout (0.00s) === RUN TestRcCleanup rc_test.go:30: Skipping test on non local remote --- SKIP: TestRcCleanup (0.00s) === RUN TestRcCopyfile rc_test.go:30: Skipping test on non local remote --- SKIP: TestRcCopyfile (0.00s) === RUN TestRcCopyurl rc_test.go:30: Skipping test on non local remote --- SKIP: TestRcCopyurl (0.00s) === RUN TestRcDelete rc_test.go:30: Skipping test on non local remote --- SKIP: TestRcDelete (0.00s) === RUN TestRcDeletefile rc_test.go:30: Skipping test on non local remote --- SKIP: TestRcDeletefile (0.00s) === RUN TestRcList rc_test.go:30: Skipping test on non local remote --- SKIP: TestRcList (0.00s) === RUN TestRcStat rc_test.go:30: Skipping test on non local remote --- SKIP: TestRcStat (0.00s) === RUN TestRcSetTier rc_test.go:30: Skipping test on non local remote --- SKIP: TestRcSetTier (0.00s) === RUN TestRcSetTierFile rc_test.go:30: Skipping test on non local remote --- SKIP: TestRcSetTierFile (0.00s) === RUN TestRcMkdir rc_test.go:30: Skipping test on non local remote --- SKIP: TestRcMkdir (0.00s) === RUN TestRcMovefile rc_test.go:30: Skipping test on non local remote --- SKIP: TestRcMovefile (0.00s) === RUN TestRcPurge rc_test.go:30: Skipping test on non local remote --- SKIP: TestRcPurge (0.00s) === RUN TestRcRmdir rc_test.go:30: Skipping test on non local remote --- SKIP: TestRcRmdir (0.00s) === RUN TestRcRmdirs rc_test.go:30: Skipping test on non local remote --- SKIP: TestRcRmdirs (0.00s) === RUN TestRcSize rc_test.go:30: Skipping test on non local remote --- SKIP: TestRcSize (0.00s) === RUN TestRcPublicLink rc_test.go:30: Skipping test on non local remote --- SKIP: TestRcPublicLink (0.00s) === RUN TestRcFsInfo rc_test.go:30: Skipping test on non local remote --- SKIP: TestRcFsInfo (0.00s) === RUN TestUploadFile rc_test.go:30: Skipping test on non local remote --- SKIP: TestUploadFile (0.00s) === RUN TestRcCommand rc_test.go:30: Skipping test on non local remote --- SKIP: TestRcCommand (0.00s) === RUN TestRcDu rc_test.go:30: Skipping test on non local remote --- SKIP: TestRcDu (0.00s) === RUN TestRcCheck rc_test.go:30: Skipping test on non local remote --- SKIP: TestRcCheck (0.00s) === RUN TestRcHashsum rc_test.go:30: Skipping test on non local remote --- SKIP: TestRcHashsum (0.00s) === RUN TestRcHashsumFile rc_test.go:30: Skipping test on non local remote --- SKIP: TestRcHashsumFile (0.00s) PASS 2024/12/21 02:27:18 DEBUG : Encrypted drive 'TestCryptSwift:rclone-test-kehimox8xoli': Purge remote 2024/12/21 02:27:18 DEBUG : Waiting for deletions to finish "./operations.test -test.v -test.timeout 1h0m0s -remote TestCryptSwift: -verbose" - Finished OK in 3m29.882450697s (try 1/5)