"./sync.test -test.v -test.timeout 1h0m0s -remote TestPixeldrain: -verbose -test.run '^(TestCopy|TestCopyEmptyDirectories|TestCopyMetadata|TestCopyMetadataNoEmptyDirs|TestMoveEmptyDirectories|TestNothingToTransferWithEmptyDirs|TestNothingToTransferWithoutEmptyDirs|TestSyncBackupDir|TestSyncBackupDirWithSuffix|TestSyncBackupDirWithSuffixKeepExtension|TestSyncEmptyDirectories)$'" - Starting (try 2/5) 2026/07/10 03:00:32 DEBUG : Creating backend with remote "TestPixeldrain:rclone-test-hesanep8neci" 2026/07/10 03:00:32 DEBUG : Using config file from "/home/rclone/.rclone.conf" 2026/07/10 03:00:32 INFO : pixeldrain root 'rclone-test-hesanep8neci': Logged in as 'ncw', subscription 'Prepaid', storage limit -1 2026/07/10 03:00:32 DEBUG : Creating backend with remote "/tmp/rclone592483877" === RUN TestCopy run.go:198: Remote "pixeldrain root 'rclone-test-hesanep8neci'", Local "Local file system at /tmp/rclone592483877", Modify Window "1ms" 2026/07/10 03:00:32 INFO : sub dir: Set directory modification time (using DirSetModTime) 2026/07/10 03:00:32 DEBUG : Added delayed dir = "sub dir", newDst= 2026/07/10 03:00:32 DEBUG : sub dir/hello world: Need to transfer - File not found at Destination 2026/07/10 03:00:32 DEBUG : pixeldrain root 'rclone-test-hesanep8neci': Waiting for checks to finish 2026/07/10 03:00:32 DEBUG : pixeldrain root 'rclone-test-hesanep8neci': Waiting for transfers to finish 2026/07/10 03:00:32 DEBUG : sub dir/hello world: size = 11 OK 2026/07/10 03:00:32 DEBUG : sub dir/hello world: sha256 = b94d27b9934d3e08a52e52d7da7dabfac484efe37a5380ee9088f7ace2efcde9 OK 2026/07/10 03:00:32 INFO : sub dir/hello world: Copied (new) 2026/07/10 03:00:32 INFO : sub dir: Set directory modification time (using DirSetModTime) fstest.go:127: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:127 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:639 /home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:391 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:86 Error: Should be true Test: TestCopy Messages: sub dir: Modification time difference too big |-127454h0m33.600543211s| > 1ms (want 2011-12-25 12:59:59.123456789 +0000 UTC vs got 2026-07-10 03:00:32.724 +0000 UTC) (precision 1ms) --- FAIL: TestCopy (0.36s) === RUN TestCopyMetadata run.go:198: Remote "pixeldrain root 'rclone-test-hesanep8neci'", Local "Local file system at /tmp/rclone592483877", Modify Window "1ms" 2026/07/10 03:00:33 DEBUG : metadata sub dir: Making directory with metadata 2026/07/10 03:00:33 INFO : metadata sub dir: Made directory with metadata (mtime=2011-12-25T12:59:59.123456789Z) 2026/07/10 03:00:33 DEBUG : empty metadata sub dir: Making directory with metadata 2026/07/10 03:00:33 INFO : empty metadata sub dir: Made directory with metadata (mtime=2011-12-25T12:59:59.123456789Z) 2026/07/10 03:00:33 DEBUG : Local file system at /tmp/rclone592483877: File to upload is small (21 bytes), uploading instead of streaming 2026/07/10 03:00:33 DEBUG : metadata sub dir/hello metadata world: size = 21 OK 2026/07/10 03:00:33 DEBUG : metadata sub dir/hello metadata world: md5 = baa7a013449dbba2b1ed02b5cfb4e1a2 OK 2026/07/10 03:00:33 DEBUG : metadata sub dir/hello metadata world: Size and md5 of src and dst objects identical 2026/07/10 03:00:33 INFO : metadata sub dir: Set directory modification time (using DirSetModTime) 2026/07/10 03:00:33 INFO : empty metadata sub dir: Making directory 2026/07/10 03:00:33 INFO : empty metadata sub dir: Made directory with modification time 2011-12-25 12:59:59.123456789 +0000 UTC 2026/07/10 03:00:33 INFO : metadata sub dir: Making directory 2026/07/10 03:00:33 INFO : metadata sub dir: Made directory with modification time 2011-12-25 12:59:59.123456789 +0000 UTC 2026/07/10 03:00:33 DEBUG : metadata sub dir/hello metadata world: Need to transfer - File not found at Destination 2026/07/10 03:00:33 DEBUG : pixeldrain root 'rclone-test-hesanep8neci': Waiting for checks to finish 2026/07/10 03:00:33 DEBUG : pixeldrain root 'rclone-test-hesanep8neci': Waiting for transfers to finish 2026/07/10 03:00:33 DEBUG : metadata sub dir/hello metadata world: size = 21 OK 2026/07/10 03:00:33 DEBUG : metadata sub dir/hello metadata world: sha256 = 64d5652158c99e4dd08097075e4e76b287f3b63667c0968c7867720a543c6916 OK 2026/07/10 03:00:33 INFO : metadata sub dir/hello metadata world: Copied (new) fstest.go:127: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:127 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:639 /home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:391 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:153 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:177 Error: Should be true Test: TestCopyMetadata Messages: metadata sub dir: Modification time difference too big |-127454h0m33.983543211s| > 1ms (want 2011-12-25 12:59:59.123456789 +0000 UTC vs got 2026-07-10 03:00:33.107 +0000 UTC) (precision 1ms) --- FAIL: TestCopyMetadata (0.52s) === RUN TestCopyMetadataNoEmptyDirs run.go:198: Remote "pixeldrain root 'rclone-test-hesanep8neci'", Local "Local file system at /tmp/rclone592483877", Modify Window "1ms" 2026/07/10 03:00:33 DEBUG : metadata sub dir: Making directory with metadata 2026/07/10 03:00:33 INFO : metadata sub dir: Made directory with metadata (mtime=2011-12-25T12:59:59.123456789Z) 2026/07/10 03:00:33 DEBUG : empty metadata sub dir: Making directory with metadata 2026/07/10 03:00:33 INFO : empty metadata sub dir: Made directory with metadata (mtime=2011-12-25T12:59:59.123456789Z) 2026/07/10 03:00:33 DEBUG : Local file system at /tmp/rclone592483877: File to upload is small (21 bytes), uploading instead of streaming 2026/07/10 03:00:33 DEBUG : metadata sub dir/hello metadata world: size = 21 OK 2026/07/10 03:00:33 DEBUG : metadata sub dir/hello metadata world: md5 = baa7a013449dbba2b1ed02b5cfb4e1a2 OK 2026/07/10 03:00:33 DEBUG : metadata sub dir/hello metadata world: Size and md5 of src and dst objects identical 2026/07/10 03:00:33 INFO : metadata sub dir: Set directory modification time (using DirSetModTime) 2026/07/10 03:00:33 DEBUG : Added delayed dir = "empty metadata sub dir", newDst= 2026/07/10 03:00:33 DEBUG : Added delayed dir = "metadata sub dir", newDst= 2026/07/10 03:00:33 DEBUG : metadata sub dir/hello metadata world: Need to transfer - File not found at Destination 2026/07/10 03:00:33 DEBUG : pixeldrain root 'rclone-test-hesanep8neci': Waiting for checks to finish 2026/07/10 03:00:33 DEBUG : pixeldrain root 'rclone-test-hesanep8neci': Waiting for transfers to finish 2026/07/10 03:00:33 DEBUG : metadata sub dir/hello metadata world: size = 21 OK 2026/07/10 03:00:33 DEBUG : metadata sub dir/hello metadata world: sha256 = 64d5652158c99e4dd08097075e4e76b287f3b63667c0968c7867720a543c6916 OK 2026/07/10 03:00:33 INFO : metadata sub dir/hello metadata world: Copied (new) 2026/07/10 03:00:33 INFO : metadata sub dir: Set directory modification time (using DirSetModTime) fstest.go:127: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:127 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:639 /home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:391 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:153 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:181 Error: Should be true Test: TestCopyMetadataNoEmptyDirs Messages: metadata sub dir: Modification time difference too big |-127454h0m34.444543211s| > 1ms (want 2011-12-25 12:59:59.123456789 +0000 UTC vs got 2026-07-10 03:00:33.568 +0000 UTC) (precision 1ms) --- FAIL: TestCopyMetadataNoEmptyDirs (0.38s) === RUN TestCopyEmptyDirectories run.go:198: Remote "pixeldrain root 'rclone-test-hesanep8neci'", Local "Local file system at /tmp/rclone592483877", Modify Window "1ms" 2026/07/10 03:00:33 DEBUG : sub dir2/sub sub dir2: Making directory with metadata 2026/07/10 03:00:33 INFO : sub dir2/sub sub dir2: Made directory with metadata (mtime=2011-12-25T12:59:59.123456789Z) 2026/07/10 03:00:33 INFO : sub dir2: Set directory modification time (using DirSetModTime) 2026/07/10 03:00:33 INFO : sub dir: Set directory modification time (using DirSetModTime) 2026/07/10 03:00:33 INFO : sub dir2: Making directory 2026/07/10 03:00:34 INFO : sub dir2: Made directory with modification time 2011-12-25 12:59:59.123456789 +0000 UTC 2026/07/10 03:00:34 INFO : sub dir: Making directory 2026/07/10 03:00:34 INFO : sub dir: Made directory with modification time 2001-02-03 04:05:06.499999999 +0000 UTC 2026/07/10 03:00:34 INFO : sub dir2/sub sub dir2: Making directory 2026/07/10 03:00:34 DEBUG : sub dir/hello world: Need to transfer - File not found at Destination 2026/07/10 03:00:34 DEBUG : sub dir/hello world: size = 11 OK 2026/07/10 03:00:34 DEBUG : sub dir/hello world: sha256 = b94d27b9934d3e08a52e52d7da7dabfac484efe37a5380ee9088f7ace2efcde9 OK 2026/07/10 03:00:34 INFO : sub dir/hello world: Copied (new) 2026/07/10 03:00:34 INFO : sub dir2/sub sub dir2: Made directory with modification time 2011-12-25 12:59:59.123456789 +0000 UTC 2026/07/10 03:00:34 DEBUG : pixeldrain root 'rclone-test-hesanep8neci': Waiting for checks to finish 2026/07/10 03:00:34 DEBUG : pixeldrain root 'rclone-test-hesanep8neci': Waiting for transfers to finish fstest.go:127: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:127 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:639 /home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:391 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:371 Error: Should be true Test: TestCopyEmptyDirectories Messages: sub dir: Modification time difference too big |-222910h55m27.506000001s| > 1ms (want 2001-02-03 04:05:06.499999999 +0000 UTC vs got 2026-07-10 03:00:34.006 +0000 UTC) (precision 1ms) fstest.go:127: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:127 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:639 /home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:391 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:371 Error: Should be true Test: TestCopyEmptyDirectories Messages: sub dir2: Modification time difference too big |-127454h0m34.823543211s| > 1ms (want 2011-12-25 12:59:59.123456789 +0000 UTC vs got 2026-07-10 03:00:33.947 +0000 UTC) (precision 1ms) fstest.go:127: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:127 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:639 /home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:391 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:371 Error: Should be true Test: TestCopyEmptyDirectories Messages: sub dir2/sub sub dir2: Modification time difference too big |-127454h0m34.941543211s| > 1ms (want 2011-12-25 12:59:59.123456789 +0000 UTC vs got 2026-07-10 03:00:34.065 +0000 UTC) (precision 1ms) --- FAIL: TestCopyEmptyDirectories (0.59s) === RUN TestMoveEmptyDirectories run.go:198: Remote "pixeldrain root 'rclone-test-hesanep8neci'", Local "Local file system at /tmp/rclone592483877", Modify Window "1ms" 2026/07/10 03:00:34 DEBUG : sub dir2: Making directory with metadata 2026/07/10 03:00:34 INFO : sub dir2: Made directory with metadata (mtime=2011-12-25T12:59:59.123456789Z) 2026/07/10 03:00:34 INFO : sub dir2: Making directory 2026/07/10 03:00:34 INFO : sub dir2: Made directory with modification time 2011-12-25 12:59:59.123456789 +0000 UTC 2026/07/10 03:00:34 INFO : sub dir: Making directory 2026/07/10 03:00:34 INFO : sub dir: Made directory with modification time 2026-07-10 03:00:34.530509443 +0000 UTC 2026/07/10 03:00:34 DEBUG : sub dir/hello world: Need to transfer - File not found at Destination 2026/07/10 03:00:34 DEBUG : pixeldrain root 'rclone-test-hesanep8neci': Waiting for checks to finish 2026/07/10 03:00:34 DEBUG : pixeldrain root 'rclone-test-hesanep8neci': Waiting for transfers to finish 2026/07/10 03:00:34 DEBUG : sub dir/hello world: size = 11 OK 2026/07/10 03:00:34 DEBUG : sub dir/hello world: sha256 = b94d27b9934d3e08a52e52d7da7dabfac484efe37a5380ee9088f7ace2efcde9 OK 2026/07/10 03:00:34 INFO : sub dir/hello world: Copied (new) 2026/07/10 03:00:34 INFO : sub dir/hello world: Deleted --- PASS: TestMoveEmptyDirectories (0.50s) === RUN TestSyncEmptyDirectories run.go:198: Remote "pixeldrain root 'rclone-test-hesanep8neci'", Local "Local file system at /tmp/rclone592483877", Modify Window "1ms" 2026/07/10 03:00:35 DEBUG : sub dir2: Making directory with metadata 2026/07/10 03:00:35 INFO : sub dir2: Made directory with metadata (mtime=2011-12-25T12:59:59.123456789Z) 2026/07/10 03:00:35 INFO : sub dir: Set directory modification time (using DirSetModTime) 2026/07/10 03:00:35 INFO : sub dir2: Making directory 2026/07/10 03:00:35 INFO : sub dir2: Made directory with modification time 2011-12-25 12:59:59.123456789 +0000 UTC 2026/07/10 03:00:35 INFO : sub dir: Making directory 2026/07/10 03:00:35 INFO : sub dir: Made directory with modification time 2001-02-03 04:05:06.499999999 +0000 UTC 2026/07/10 03:00:35 DEBUG : sub dir/hello world: Need to transfer - File not found at Destination 2026/07/10 03:00:35 DEBUG : pixeldrain root 'rclone-test-hesanep8neci': Waiting for checks to finish 2026/07/10 03:00:35 DEBUG : pixeldrain root 'rclone-test-hesanep8neci': Waiting for transfers to finish 2026/07/10 03:00:35 DEBUG : sub dir/hello world: size = 11 OK 2026/07/10 03:00:35 DEBUG : sub dir/hello world: sha256 = b94d27b9934d3e08a52e52d7da7dabfac484efe37a5380ee9088f7ace2efcde9 OK 2026/07/10 03:00:35 INFO : sub dir/hello world: Copied (new) 2026/07/10 03:00:35 DEBUG : Waiting for deletions to finish --- PASS: TestSyncEmptyDirectories (0.48s) === RUN TestSyncBackupDir run.go:198: Remote "pixeldrain root 'rclone-test-hesanep8neci'", Local "Local file system at /tmp/rclone592483877", Modify Window "1ms" 2026/07/10 03:00:35 DEBUG : Creating backend with remote "TestPixeldrain:rclone-test-hesanep8neci/dst" 2026/07/10 03:00:35 INFO : pixeldrain root 'rclone-test-hesanep8neci/dst': Logged in as 'ncw', subscription 'Prepaid', storage limit -1 2026/07/10 03:00:35 DEBUG : Creating backend with remote "TestPixeldrain:rclone-test-hesanep8neci/backup" 2026/07/10 03:00:35 INFO : pixeldrain root 'rclone-test-hesanep8neci/backup': Logged in as 'ncw', subscription 'Prepaid', storage limit -1 2026/07/10 03:00:35 DEBUG : one: size = 4 (Local file system at /tmp/rclone592483877) 2026/07/10 03:00:35 DEBUG : one: size = 3 (pixeldrain root 'rclone-test-hesanep8neci/dst') 2026/07/10 03:00:35 DEBUG : one: Sizes differ 2026/07/10 03:00:35 DEBUG : two: size = 3 OK 2026/07/10 03:00:35 DEBUG : two: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2026/07/10 03:00:35 DEBUG : two: Unchanged skipping 2026/07/10 03:00:35 DEBUG : pixeldrain root 'rclone-test-hesanep8neci/dst': Waiting for checks to finish 2026/07/10 03:00:35 INFO : one: Moved (server-side) 2026/07/10 03:00:35 DEBUG : pixeldrain root 'rclone-test-hesanep8neci/dst': Waiting for transfers to finish 2026/07/10 03:00:36 DEBUG : one: size = 4 OK 2026/07/10 03:00:36 DEBUG : one: sha256 = adefbbf0dff80800a3eb8cd37fa8160a530c6ab1fed4f44001b69139c5177a93 OK 2026/07/10 03:00:36 INFO : one: Copied (new) 2026/07/10 03:00:36 DEBUG : Waiting for deletions to finish 2026/07/10 03:00:36 INFO : three.txt: Moved (server-side) 2026/07/10 03:00:36 INFO : three.txt: Moved into backup dir fstest.go:298: Sleeping for 1s for list eventual consistency: 1/3 fstest.go:298: Sleeping for 2s for list eventual consistency: 2/3 fstest.go:298: Sleeping for 4s for list eventual consistency: 3/3 fstest.go:305: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:305 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:338 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:350 /home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:358 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2429 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2458 /usr/local/go/src/runtime/asm_amd64.s:1771 Error: Should be true Test: TestSyncBackupDir Messages: listing wrong, want backup/one (3), backup/three.txt (5), dst/one (4), dst/two (3) got backup/one (3), backup/three.txt (5), dst/two (3) fstest.go:203: Not found "dst/one" fstest.go:206: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:206 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:310 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:338 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:350 /home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:358 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2429 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2458 Error: Not equal: expected: 0 actual : 1 Test: TestSyncBackupDir Messages: 1 objects not found fstest.go:298: Sleeping for 1s for list eventual consistency: 1/3 fstest.go:298: Sleeping for 2s for list eventual consistency: 2/3 fstest.go:298: Sleeping for 4s for list eventual consistency: 3/3 fstest.go:305: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:305 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:338 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:350 /home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:358 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2435 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2458 /usr/local/go/src/runtime/asm_amd64.s:1771 Error: Should be true Test: TestSyncBackupDir Messages: listing wrong, want backup/one (3), backup/three.txt (5), dst/one (4), dst/three.txt (6), dst/two (3) got backup/one (3), backup/three.txt (5), dst/three.txt (6), dst/two (3) fstest.go:203: Not found "dst/one" fstest.go:206: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:206 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:310 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:338 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:350 /home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:358 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2435 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2458 Error: Not equal: expected: 0 actual : 1 Test: TestSyncBackupDir Messages: 1 objects not found 2026/07/10 03:00:50 DEBUG : one: Need to transfer - File not found at Destination 2026/07/10 03:00:50 DEBUG : pixeldrain root 'rclone-test-hesanep8neci/dst': Waiting for checks to finish 2026/07/10 03:00:50 DEBUG : two: size = 3 OK 2026/07/10 03:00:50 DEBUG : two: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2026/07/10 03:00:50 DEBUG : two: Unchanged skipping 2026/07/10 03:00:50 DEBUG : pixeldrain root 'rclone-test-hesanep8neci/dst': Waiting for transfers to finish 2026/07/10 03:00:50 DEBUG : one: size = 5 OK 2026/07/10 03:00:50 DEBUG : one: sha256 = 517b021836359b3420b6082b5b16f379079452b9e0ac97b88ae86c6c757ee7b8 OK 2026/07/10 03:00:50 INFO : one: Copied (new) 2026/07/10 03:00:50 DEBUG : Waiting for deletions to finish 2026/07/10 03:00:50 INFO : three.txt: Deleted 2026/07/10 03:00:50 INFO : three.txt: Moved (server-side) 2026/07/10 03:00:50 INFO : three.txt: Moved into backup dir fstest.go:298: Sleeping for 1s for list eventual consistency: 1/3 fstest.go:298: Sleeping for 2s for list eventual consistency: 2/3 fstest.go:298: Sleeping for 4s for list eventual consistency: 3/3 fstest.go:305: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:305 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:338 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:350 /home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:358 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2454 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2458 /usr/local/go/src/runtime/asm_amd64.s:1771 Error: Should be true Test: TestSyncBackupDir Messages: listing wrong, want backup/one (4), backup/three.txt (6), dst/one (5), dst/two (3) got backup/one (3), backup/three.txt (6), dst/one (5), dst/two (3) fstest.go:143: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:143 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:149 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:195 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:308 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:338 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:350 /home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:358 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2454 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2458 Error: Should be true Test: TestSyncBackupDir Messages: pixeldrain root 'rclone-test-hesanep8neci'/backup/one: sha256 hash incorrect - expecting "adefbbf0dff80800a3eb8cd37fa8160a530c6ab1fed4f44001b69139c5177a93" got "7692c3ad3540bb803c020b3aee66cd8887123234ea0c6e7143c0add73ff431ed" fstest.go:150: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:150 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:195 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:308 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:338 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:350 /home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:358 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2454 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2458 Error: Not equal: expected: 4 actual : 3 Test: TestSyncBackupDir Messages: backup/one: size incorrect file=4 vs obj=3 fstest.go:127: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:127 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:132 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:151 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:195 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:308 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:338 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:350 /home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:358 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2454 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2458 Error: Should be true Test: TestSyncBackupDir Messages: backup/one: Modification time difference too big |95456h54m52.624456789s| > 1ms (want 2011-12-25 12:59:59.123456789 +0000 UTC vs got 2001-02-03 04:05:06.499 +0000 UTC) (precision 1ms) --- FAIL: TestSyncBackupDir (22.65s) === RUN TestSyncBackupDirWithSuffix run.go:198: Remote "pixeldrain root 'rclone-test-hesanep8neci'", Local "Local file system at /tmp/rclone592483877", Modify Window "1ms" 2026/07/10 03:00:58 DEBUG : Creating backend with remote "TestPixeldrain:rclone-test-hesanep8neci/dst" 2026/07/10 03:00:58 INFO : pixeldrain root 'rclone-test-hesanep8neci/dst': Logged in as 'ncw', subscription 'Prepaid', storage limit -1 2026/07/10 03:00:58 DEBUG : Creating backend with remote "TestPixeldrain:rclone-test-hesanep8neci/backup" 2026/07/10 03:00:58 INFO : pixeldrain root 'rclone-test-hesanep8neci/backup': Logged in as 'ncw', subscription 'Prepaid', storage limit -1 2026/07/10 03:00:58 DEBUG : one: size = 4 (Local file system at /tmp/rclone592483877) 2026/07/10 03:00:58 DEBUG : one: size = 3 (pixeldrain root 'rclone-test-hesanep8neci/dst') 2026/07/10 03:00:58 DEBUG : one: Sizes differ 2026/07/10 03:00:58 DEBUG : two: size = 3 OK 2026/07/10 03:00:58 DEBUG : two: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2026/07/10 03:00:58 DEBUG : pixeldrain root 'rclone-test-hesanep8neci/dst': Waiting for checks to finish 2026/07/10 03:00:58 DEBUG : two: Unchanged skipping 2026/07/10 03:00:58 INFO : one: Moved (server-side) to: one.bak 2026/07/10 03:00:58 DEBUG : pixeldrain root 'rclone-test-hesanep8neci/dst': Waiting for transfers to finish 2026/07/10 03:00:58 DEBUG : one: size = 4 OK 2026/07/10 03:00:58 DEBUG : one: sha256 = adefbbf0dff80800a3eb8cd37fa8160a530c6ab1fed4f44001b69139c5177a93 OK 2026/07/10 03:00:58 INFO : one: Copied (new) 2026/07/10 03:00:58 DEBUG : Waiting for deletions to finish 2026/07/10 03:00:58 INFO : three.txt: Moved (server-side) to: three.txt.bak 2026/07/10 03:00:58 INFO : three.txt: Moved into backup dir fstest.go:298: Sleeping for 1s for list eventual consistency: 1/3 fstest.go:298: Sleeping for 2s for list eventual consistency: 2/3 fstest.go:298: Sleeping for 4s for list eventual consistency: 3/3 fstest.go:305: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:305 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:338 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:350 /home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:358 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2429 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2462 /usr/local/go/src/runtime/asm_amd64.s:1771 Error: Should be true Test: TestSyncBackupDirWithSuffix Messages: listing wrong, want backup/one.bak (3), backup/three.txt.bak (5), dst/one (4), dst/two (3) got backup/one.bak (3), backup/three.txt.bak (5), dst/two (3) fstest.go:203: Not found "dst/one" fstest.go:206: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:206 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:310 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:338 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:350 /home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:358 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2429 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2462 Error: Not equal: expected: 0 actual : 1 Test: TestSyncBackupDirWithSuffix Messages: 1 objects not found fstest.go:298: Sleeping for 1s for list eventual consistency: 1/3 fstest.go:298: Sleeping for 2s for list eventual consistency: 2/3 fstest.go:298: Sleeping for 4s for list eventual consistency: 3/3 fstest.go:305: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:305 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:338 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:350 /home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:358 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2435 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2462 /usr/local/go/src/runtime/asm_amd64.s:1771 Error: Should be true Test: TestSyncBackupDirWithSuffix Messages: listing wrong, want backup/one.bak (3), backup/three.txt.bak (5), dst/one (4), dst/three.txt (6), dst/two (3) got backup/one.bak (3), backup/three.txt.bak (5), dst/three.txt (6), dst/two (3) fstest.go:203: Not found "dst/one" fstest.go:206: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:206 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:310 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:338 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:350 /home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:358 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2435 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2462 Error: Not equal: expected: 0 actual : 1 Test: TestSyncBackupDirWithSuffix Messages: 1 objects not found 2026/07/10 03:01:13 DEBUG : one: Need to transfer - File not found at Destination 2026/07/10 03:01:13 DEBUG : two: size = 3 OK 2026/07/10 03:01:13 DEBUG : two: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2026/07/10 03:01:13 DEBUG : two: Unchanged skipping 2026/07/10 03:01:13 DEBUG : pixeldrain root 'rclone-test-hesanep8neci/dst': Waiting for checks to finish 2026/07/10 03:01:13 DEBUG : pixeldrain root 'rclone-test-hesanep8neci/dst': Waiting for transfers to finish 2026/07/10 03:01:13 DEBUG : one: size = 5 OK 2026/07/10 03:01:13 DEBUG : one: sha256 = 517b021836359b3420b6082b5b16f379079452b9e0ac97b88ae86c6c757ee7b8 OK 2026/07/10 03:01:13 INFO : one: Copied (new) 2026/07/10 03:01:13 DEBUG : Waiting for deletions to finish 2026/07/10 03:01:13 INFO : three.txt.bak: Deleted 2026/07/10 03:01:13 INFO : three.txt: Moved (server-side) to: three.txt.bak 2026/07/10 03:01:13 INFO : three.txt: Moved into backup dir fstest.go:298: Sleeping for 1s for list eventual consistency: 1/3 fstest.go:298: Sleeping for 2s for list eventual consistency: 2/3 fstest.go:298: Sleeping for 4s for list eventual consistency: 3/3 fstest.go:305: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:305 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:338 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:350 /home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:358 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2454 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2462 /usr/local/go/src/runtime/asm_amd64.s:1771 Error: Should be true Test: TestSyncBackupDirWithSuffix Messages: listing wrong, want backup/one.bak (4), backup/three.txt.bak (6), dst/one (5), dst/two (3) got backup/one.bak (3), backup/three.txt.bak (6), dst/one (5), dst/two (3) fstest.go:143: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:143 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:149 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:195 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:308 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:338 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:350 /home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:358 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2454 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2462 Error: Should be true Test: TestSyncBackupDirWithSuffix Messages: pixeldrain root 'rclone-test-hesanep8neci'/backup/one.bak: sha256 hash incorrect - expecting "adefbbf0dff80800a3eb8cd37fa8160a530c6ab1fed4f44001b69139c5177a93" got "7692c3ad3540bb803c020b3aee66cd8887123234ea0c6e7143c0add73ff431ed" fstest.go:150: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:150 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:195 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:308 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:338 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:350 /home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:358 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2454 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2462 Error: Not equal: expected: 4 actual : 3 Test: TestSyncBackupDirWithSuffix Messages: backup/one.bak: size incorrect file=4 vs obj=3 fstest.go:127: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:127 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:132 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:151 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:195 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:308 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:338 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:350 /home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:358 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2454 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2462 Error: Should be true Test: TestSyncBackupDirWithSuffix Messages: backup/one.bak: Modification time difference too big |95456h54m52.624456789s| > 1ms (want 2011-12-25 12:59:59.123456789 +0000 UTC vs got 2001-02-03 04:05:06.499 +0000 UTC) (precision 1ms) --- FAIL: TestSyncBackupDirWithSuffix (22.63s) === RUN TestSyncBackupDirWithSuffixKeepExtension run.go:198: Remote "pixeldrain root 'rclone-test-hesanep8neci'", Local "Local file system at /tmp/rclone592483877", Modify Window "1ms" 2026/07/10 03:01:20 DEBUG : Creating backend with remote "TestPixeldrain:rclone-test-hesanep8neci/dst" 2026/07/10 03:01:21 INFO : pixeldrain root 'rclone-test-hesanep8neci/dst': Logged in as 'ncw', subscription 'Prepaid', storage limit -1 2026/07/10 03:01:21 DEBUG : Creating backend with remote "TestPixeldrain:rclone-test-hesanep8neci/backup" 2026/07/10 03:01:21 INFO : pixeldrain root 'rclone-test-hesanep8neci/backup': Logged in as 'ncw', subscription 'Prepaid', storage limit -1 2026/07/10 03:01:21 DEBUG : one: size = 4 (Local file system at /tmp/rclone592483877) 2026/07/10 03:01:21 DEBUG : pixeldrain root 'rclone-test-hesanep8neci/dst': Waiting for checks to finish 2026/07/10 03:01:21 DEBUG : one: size = 3 (pixeldrain root 'rclone-test-hesanep8neci/dst') 2026/07/10 03:01:21 DEBUG : one: Sizes differ 2026/07/10 03:01:21 DEBUG : two: size = 3 OK 2026/07/10 03:01:21 DEBUG : two: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2026/07/10 03:01:21 DEBUG : two: Unchanged skipping 2026/07/10 03:01:21 INFO : one: Moved (server-side) to: one-2019-01-01 2026/07/10 03:01:21 DEBUG : pixeldrain root 'rclone-test-hesanep8neci/dst': Waiting for transfers to finish 2026/07/10 03:01:21 DEBUG : one: size = 4 OK 2026/07/10 03:01:21 DEBUG : one: sha256 = adefbbf0dff80800a3eb8cd37fa8160a530c6ab1fed4f44001b69139c5177a93 OK 2026/07/10 03:01:21 INFO : one: Copied (new) 2026/07/10 03:01:21 DEBUG : Waiting for deletions to finish 2026/07/10 03:01:21 INFO : three.txt: Moved (server-side) to: three-2019-01-01.txt 2026/07/10 03:01:21 INFO : three.txt: Moved into backup dir 2026/07/10 03:01:21 DEBUG : two: size = 3 OK 2026/07/10 03:01:21 DEBUG : two: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2026/07/10 03:01:21 DEBUG : pixeldrain root 'rclone-test-hesanep8neci/dst': Waiting for checks to finish 2026/07/10 03:01:21 DEBUG : two: Unchanged skipping 2026/07/10 03:01:21 DEBUG : one: size = 5 (Local file system at /tmp/rclone592483877) 2026/07/10 03:01:21 DEBUG : one: size = 4 (pixeldrain root 'rclone-test-hesanep8neci/dst') 2026/07/10 03:01:21 DEBUG : one: Sizes differ 2026/07/10 03:01:21 INFO : one-2019-01-01: Deleted 2026/07/10 03:01:21 INFO : one: Moved (server-side) to: one-2019-01-01 2026/07/10 03:01:21 DEBUG : pixeldrain root 'rclone-test-hesanep8neci/dst': Waiting for transfers to finish 2026/07/10 03:01:21 DEBUG : one: size = 5 OK 2026/07/10 03:01:21 DEBUG : one: sha256 = 517b021836359b3420b6082b5b16f379079452b9e0ac97b88ae86c6c757ee7b8 OK 2026/07/10 03:01:21 INFO : one: Copied (new) 2026/07/10 03:01:21 DEBUG : Waiting for deletions to finish 2026/07/10 03:01:21 INFO : three-2019-01-01.txt: Deleted 2026/07/10 03:01:21 INFO : three.txt: Moved (server-side) to: three-2019-01-01.txt 2026/07/10 03:01:21 INFO : three.txt: Moved into backup dir --- PASS: TestSyncBackupDirWithSuffixKeepExtension (1.30s) === RUN TestNothingToTransferWithEmptyDirs run.go:198: Remote "pixeldrain root 'rclone-test-hesanep8neci'", Local "Local file system at /tmp/rclone592483877", Modify Window "1ms" 2026/07/10 03:01:22 INFO : sub dir: Set directory modification time (using DirSetModTime) 2026/07/10 03:01:22 INFO : sub dir: Making directory 2026/07/10 03:01:22 INFO : sub dir: Made directory with modification time 2011-12-30 12:59:59 +0000 UTC fstest.go:127: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:127 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:639 /home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:391 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2906 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2977 Error: Should be true Test: TestNothingToTransferWithEmptyDirs Messages: sub dir2: Modification time difference too big |-68.402638ms| > 1ms (want 2026-07-10 03:01:22.096597362 +0000 UTC vs got 2026-07-10 03:01:22.165 +0000 UTC) (precision 1ms) sync_test.go:2933: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2933 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2977 Error: Should be false Test: TestNothingToTransferWithEmptyDirs Messages: expected to find no "Set directory modification time" logs, but found one: 2026/07/10 03:01:23 INFO : sub dir2: Set directory modification time (using DirSetModTime) 2026/07/10 03:01:23 INFO : There was nothing to transfer sync_test.go:2935: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2935 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2977 Error: Should be false Test: TestNothingToTransferWithEmptyDirs Messages: expected to find no "directory"-related logs, but found one: 2026/07/10 03:01:23 INFO : sub dir2: Set directory modification time (using DirSetModTime) 2026/07/10 03:01:23 INFO : There was nothing to transfer 2026/07/10 03:01:23 INFO : sub dir2: Set directory modification time (using DirSetModTime) 2026/07/10 03:01:23 INFO : sub dir2: Set directory modification time (using DirSetModTime) 2026/07/10 03:01:23 INFO : sub dirEmpty/sub dirEmpty2: Made directory with metadata (mtime=2011-12-25T12:59:59.123456789Z) 2026/07/10 03:01:23 INFO : sub dirEmpty: Set directory modification time (using DirSetModTime) fstest.go:127: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:127 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:639 /home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:391 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2967 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2977 Error: Should be true Test: TestNothingToTransferWithEmptyDirs Messages: sub dirEmpty: Modification time difference too big |-127454h1m24.804543211s| > 1ms (want 2011-12-25 12:59:59.123456789 +0000 UTC vs got 2026-07-10 03:01:23.928 +0000 UTC) (precision 1ms) fstest.go:127: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:127 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:639 /home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:391 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2967 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2977 Error: Should be true Test: TestNothingToTransferWithEmptyDirs Messages: sub dirEmpty/sub dirEmpty2: Modification time difference too big |-127454h1m24.892543211s| > 1ms (want 2011-12-25 12:59:59.123456789 +0000 UTC vs got 2026-07-10 03:01:24.016 +0000 UTC) (precision 1ms) --- FAIL: TestNothingToTransferWithEmptyDirs (3.47s) === RUN TestNothingToTransferWithoutEmptyDirs run.go:198: Remote "pixeldrain root 'rclone-test-hesanep8neci'", Local "Local file system at /tmp/rclone592483877", Modify Window "1ms" 2026/07/10 03:01:25 INFO : sub dir: Set directory modification time (using DirSetModTime) 2026/07/10 03:01:25 INFO : sub dir: Making directory 2026/07/10 03:01:25 INFO : sub dir: Made directory with modification time 2011-12-30 12:59:59 +0000 UTC fstest.go:127: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:127 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:639 /home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:391 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2906 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2981 Error: Should be true Test: TestNothingToTransferWithoutEmptyDirs Messages: sub dir2/very/very/very/very/very/nested/subdir: Modification time difference too big |-126.39634ms| > 1ms (want 2026-07-10 03:01:25.56360366 +0000 UTC vs got 2026-07-10 03:01:25.69 +0000 UTC) (precision 1ms) sync_test.go:2933: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2933 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2981 Error: Should be false Test: TestNothingToTransferWithoutEmptyDirs Messages: expected to find no "Set directory modification time" logs, but found one: 2026/07/10 03:01:26 INFO : sub dir2/very/very/very/very/very/nested/subdir: Set directory modification time (using DirSetModTime) 2026/07/10 03:01:26 INFO : There was nothing to transfer sync_test.go:2935: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2935 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2981 Error: Should be false Test: TestNothingToTransferWithoutEmptyDirs Messages: expected to find no "directory"-related logs, but found one: 2026/07/10 03:01:26 INFO : sub dir2/very/very/very/very/very/nested/subdir: Set directory modification time (using DirSetModTime) 2026/07/10 03:01:26 INFO : There was nothing to transfer 2026/07/10 03:01:27 INFO : sub dir2: Set directory modification time (using DirSetModTime) 2026/07/10 03:01:27 INFO : sub dir2: Set directory modification time (using DirSetModTime) 2026/07/10 03:01:27 INFO : sub dirEmpty/sub dirEmpty2: Made directory with metadata (mtime=2011-12-25T12:59:59.123456789Z) 2026/07/10 03:01:27 INFO : sub dirEmpty: Set directory modification time (using DirSetModTime) --- FAIL: TestNothingToTransferWithoutEmptyDirs (3.02s) FAIL 2026/07/10 03:01:28 DEBUG : pixeldrain root 'rclone-test-hesanep8neci': Purge remote "./sync.test -test.v -test.timeout 1h0m0s -remote TestPixeldrain: -verbose -test.run '^(TestCopy|TestCopyEmptyDirectories|TestCopyMetadata|TestCopyMetadataNoEmptyDirs|TestMoveEmptyDirectories|TestNothingToTransferWithEmptyDirs|TestNothingToTransferWithoutEmptyDirs|TestSyncBackupDir|TestSyncBackupDirWithSuffix|TestSyncBackupDirWithSuffixKeepExtension|TestSyncEmptyDirectories)$'" - Finished ERROR in 56.122782685s (try 2/5): exit status 1: Failed [TestCopy TestCopyMetadata TestCopyMetadataNoEmptyDirs TestCopyEmptyDirectories TestSyncBackupDir TestSyncBackupDirWithSuffix TestNothingToTransferWithEmptyDirs TestNothingToTransferWithoutEmptyDirs]