"./sync.test -test.v -test.timeout 1h0m0s -remote TestPcloud: -verbose -fast-list -test.run '^(TestCopyAfterDelete|TestCopyRedownload|TestMoveOverSelf|TestServerSideCopyOverSelf|TestServerSideMoveOverSelf|TestSyncAfterRemovingAFileAndAddingAFileSubDirWithErrors|TestSyncBackupDir|TestSyncBackupDirWithSuffix|TestSyncBasedOnCheckSum|TestSyncConcurrentTruncate|TestSyncCopyDest|TestSyncDeleteBefore|TestSyncDeleteDuring|TestSyncIgnoreErrors|TestSyncOverlapWithFilter|TestSyncReplaceDirModTime|TestSyncSuffixKeepExtension|TestSyncUTFNorm)$'" - Starting (try 3/5)
2025/04/14 04:49:40 DEBUG : Creating backend with remote "TestPcloud:rclone-test-tapuwug6tuda"
2025/04/14 04:49:40 DEBUG : Using config file from "/home/rclone/.rclone.conf"
2025/04/14 04:49:41 DEBUG : Creating backend with remote "/tmp/rclone1185247972"
=== RUN   TestServerSideCopyOverSelf
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
2025/04/14 04:49:42 DEBUG : Creating backend with remote "TestPcloud:rclone-test-meqixep1biwu"
    sync_test.go:626: Server side copy (if possible) pcloud root 'rclone-test-tapuwug6tuda' -> pcloud root 'rclone-test-meqixep1biwu'
2025/04/14 04:49:43 DEBUG : sub dir/hello world: Need to transfer - File not found at Destination
2025/04/14 04:49:43 DEBUG : pcloud root 'rclone-test-meqixep1biwu': Waiting for checks to finish
2025/04/14 04:49:43 DEBUG : pcloud root 'rclone-test-meqixep1biwu': Waiting for transfers to finish
2025/04/14 04:49:44 DEBUG : sub dir/hello world: sha1 = 2aae6c35c94fcfb415dbe95f408b9ce91ee846ed OK
2025/04/14 04:49:44 DEBUG : sub dir/hello world.e0e42c92.partial: renamed to: sub dir/hello world
2025/04/14 04:49:44 INFO  : sub dir/hello world: Copied (server-side copy)
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
2025/04/14 04:49:45 DEBUG : sub dir/hello world: Sizes differ (src 17 vs dst 11)
2025/04/14 04:49:45 DEBUG : pcloud root 'rclone-test-meqixep1biwu': Waiting for checks to finish
2025/04/14 04:49:45 DEBUG : pcloud root 'rclone-test-meqixep1biwu': Waiting for transfers to finish
2025/04/14 04:49:45 DEBUG : sub dir/hello world: sha1 = b84a9b2362aee3556081792f3b7abd3958da8deb OK
2025/04/14 04:49:45 DEBUG : sub dir/hello world.e4aa1b97.partial: renamed to: sub dir/hello world
2025/04/14 04:49:45 INFO  : sub dir/hello world: Copied (server-side copy)
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
2025/04/14 04:49:46 DEBUG : pcloud root 'rclone-test-meqixep1biwu': Purge remote
--- PASS: TestServerSideCopyOverSelf (5.57s)
=== RUN   TestMoveOverSelf
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
2025/04/14 04:49:47 DEBUG : pcloud root 'rclone-test-tapuwug6tuda': Waiting for checks to finish
2025/04/14 04:49:47 DEBUG : sub dir/hello world: Sizes differ (src 17 vs dst 11)
2025/04/14 04:49:47 DEBUG : pcloud root 'rclone-test-tapuwug6tuda': Waiting for transfers to finish
2025/04/14 04:49:47 DEBUG : sub dir/hello world: sha1 = b84a9b2362aee3556081792f3b7abd3958da8deb OK
2025/04/14 04:49:48 DEBUG : sub dir/hello world.55b27b22.partial: renamed to: sub dir/hello world
2025/04/14 04:49:48 INFO  : sub dir/hello world: Copied (replaced existing)
2025/04/14 04:49:48 INFO  : sub dir/hello world: Deleted
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
--- PASS: TestMoveOverSelf (1.89s)
=== RUN   TestServerSideMoveOverSelf
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
2025/04/14 04:49:49 DEBUG : Creating backend with remote "TestPcloud:rclone-test-welamaw4getu"
    sync_test.go:671: Server side copy (if possible) pcloud root 'rclone-test-tapuwug6tuda' -> pcloud root 'rclone-test-welamaw4getu'
2025/04/14 04:49:50 DEBUG : sub dir/hello world: Need to transfer - File not found at Destination
2025/04/14 04:49:50 DEBUG : pcloud root 'rclone-test-welamaw4getu': Waiting for checks to finish
2025/04/14 04:49:50 DEBUG : pcloud root 'rclone-test-welamaw4getu': Waiting for transfers to finish
2025/04/14 04:49:51 DEBUG : sub dir/hello world: sha1 = 2aae6c35c94fcfb415dbe95f408b9ce91ee846ed OK
2025/04/14 04:49:51 DEBUG : sub dir/hello world.e0e42c92.partial: renamed to: sub dir/hello world
2025/04/14 04:49:51 INFO  : sub dir/hello world: Copied (server-side copy)
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
2025/04/14 04:49:52 DEBUG : pcloud root 'rclone-test-welamaw4getu': Using server-side directory move
2025/04/14 04:49:52 INFO  : pcloud root 'rclone-test-welamaw4getu': Server side directory move failed - fallback to file moves: can't copy directory - destination already exists
2025/04/14 04:49:52 DEBUG : pcloud root 'rclone-test-welamaw4getu': Waiting for checks to finish
2025/04/14 04:49:52 DEBUG : pcloud root 'rclone-test-welamaw4getu': Waiting for transfers to finish
    fstest.go:292: Sleeping for 1s for list eventual consistency: 1/3
    fstest.go:295: Flushing the directory cache
    fstest.go:292: Sleeping for 2s for list eventual consistency: 2/3
    fstest.go:295: Flushing the directory cache
    fstest.go:292: Sleeping for 4s for list eventual consistency: 3/3
    fstest.go:295: Flushing the directory cache
    fstest.go:299: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:299
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:332
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:350
        	            				/home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:687
        	Error:      	Should be true
        	Test:       	TestServerSideMoveOverSelf
        	Messages:   	listing wrong, want
        	            	  sub dir/hello world (17) got
        	            	  
    fstest.go:197: Not found "sub dir/hello world"
    fstest.go:200: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:200
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:304
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:332
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:350
        	            				/home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:687
        	Error:      	Not equal: 
        	            	expected: 0
        	            	actual  : 1
        	Test:       	TestServerSideMoveOverSelf
        	Messages:   	1 objects not found
    fstest.go:292: Sleeping for 1s for list eventual consistency: 1/3
    fstest.go:295: Flushing the directory cache
    fstest.go:292: Sleeping for 2s for list eventual consistency: 2/3
    fstest.go:295: Flushing the directory cache
    fstest.go:292: Sleeping for 4s for list eventual consistency: 3/3
    fstest.go:295: Flushing the directory cache
    fstest.go:299: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:299
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:332
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:344
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:340
        	            				/home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:691
        	Error:      	Should be true
        	Test:       	TestServerSideMoveOverSelf
        	Messages:   	listing wrong, want
        	            	  sub dir/hello world (24) got
        	            	  
    fstest.go:197: Not found "sub dir/hello world"
    fstest.go:200: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:200
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:304
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:332
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:344
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:340
        	            				/home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:691
        	Error:      	Not equal: 
        	            	expected: 0
        	            	actual  : 1
        	Test:       	TestServerSideMoveOverSelf
        	Messages:   	1 objects not found
2025/04/14 04:50:08 DEBUG : testing file moves
2025/04/14 04:50:08 DEBUG : sub dir/hello world: Sizes differ (src 24 vs dst 11)
2025/04/14 04:50:08 DEBUG : pcloud root 'rclone-test-welamaw4getu': Waiting for checks to finish
2025/04/14 04:50:08 DEBUG : pcloud root 'rclone-test-welamaw4getu': Waiting for transfers to finish
2025/04/14 04:50:08 INFO  : sub dir/hello world: Deleted
2025/04/14 04:50:08 INFO  : sub dir/hello world: Moved (server-side)
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
2025/04/14 04:50:09 DEBUG : pcloud root 'rclone-test-welamaw4getu': Purge remote
--- FAIL: TestServerSideMoveOverSelf (20.70s)
=== RUN   TestCopyAfterDelete
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
2025/04/14 04:50:09 ERROR : : error listing: directory not found
2025/04/14 04:50:10 INFO  : Local file system at /tmp/rclone1185247972: Making directory
2025/04/14 04:50:10 DEBUG : pcloud root 'rclone-test-tapuwug6tuda': Waiting for checks to finish
2025/04/14 04:50:10 DEBUG : pcloud root 'rclone-test-tapuwug6tuda': Waiting for transfers to finish
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
--- PASS: TestCopyAfterDelete (1.44s)
=== RUN   TestCopyRedownload
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
2025/04/14 04:50:11 DEBUG : Added delayed dir = "sub dir", newDst=<nil>
2025/04/14 04:50:11 DEBUG : sub dir/hello world: Need to transfer - File not found at Destination
2025/04/14 04:50:11 DEBUG : Local file system at /tmp/rclone1185247972: Waiting for checks to finish
2025/04/14 04:50:11 DEBUG : Local file system at /tmp/rclone1185247972: Waiting for transfers to finish
2025/04/14 04:50:11 DEBUG : Couldn't parse Date: from server edef5.pcloud.com: "Mon, 14 Apr 2025 04:50:11 +0000": parsing time "Mon, 14 Apr 2025 04:50:11 +0000" as "Mon Jan _2 15:04:05 2006": cannot parse ", 14 Apr 2025 04:50:11 +0000" as " "
2025/04/14 04:50:11 DEBUG : sub dir/hello world: sha1 = 2aae6c35c94fcfb415dbe95f408b9ce91ee846ed OK
2025/04/14 04:50:11 DEBUG : sub dir/hello world.e0e42c92.partial: renamed to: sub dir/hello world
2025/04/14 04:50:11 INFO  : sub dir/hello world: Copied (new)
2025/04/14 04:50:11 INFO  : sub dir: Set directory modification time (using DirSetModTime)
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
    run.go:125: removing file "sub dir/hello world" failed - try 1/3: pcloud error: File not found. (2009)
    fstest.go:292: Sleeping for 1s for list eventual consistency: 1/3
    fstest.go:295: Flushing the directory cache
    fstest.go:292: Sleeping for 2s for list eventual consistency: 2/3
    fstest.go:295: Flushing the directory cache
    fstest.go:292: Sleeping for 4s for list eventual consistency: 3/3
    fstest.go:295: Flushing the directory cache
    fstest.go:299: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:299
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:332
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:173
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:388
        	            				/home/rclone/go/pkg/mod/golang.org/toolchain@v0.0.1-go1.23.0.linux-amd64/src/testing/testing.go:1176
        	            				/home/rclone/go/pkg/mod/golang.org/toolchain@v0.0.1-go1.23.0.linux-amd64/src/testing/testing.go:1354
        	            				/home/rclone/go/pkg/mod/golang.org/toolchain@v0.0.1-go1.23.0.linux-amd64/src/testing/testing.go:1684
        	Error:      	Should be true
        	Test:       	TestCopyRedownload
        	Messages:   	listing wrong, want
        	            	   got
        	            	  sub dir/hello world (17)
    fstest.go:185: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:185
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:302
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:332
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:173
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:388
        	            				/home/rclone/go/pkg/mod/golang.org/toolchain@v0.0.1-go1.23.0.linux-amd64/src/testing/testing.go:1176
        	            				/home/rclone/go/pkg/mod/golang.org/toolchain@v0.0.1-go1.23.0.linux-amd64/src/testing/testing.go:1354
        	            				/home/rclone/go/pkg/mod/golang.org/toolchain@v0.0.1-go1.23.0.linux-amd64/src/testing/testing.go:1684
        	Error:      	Should be true
        	Test:       	TestCopyRedownload
        	Messages:   	Unexpected file "sub dir/hello world"
    fstest.go:321: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:321
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:332
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:173
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:388
        	            				/home/rclone/go/pkg/mod/golang.org/toolchain@v0.0.1-go1.23.0.linux-amd64/src/testing/testing.go:1176
        	            				/home/rclone/go/pkg/mod/golang.org/toolchain@v0.0.1-go1.23.0.linux-amd64/src/testing/testing.go:1354
        	            				/home/rclone/go/pkg/mod/golang.org/toolchain@v0.0.1-go1.23.0.linux-amd64/src/testing/testing.go:1684
        	Error:      	Not equal: 
        	            	expected: []string{}
        	            	actual  : []string{"sub dir"}
        	            	
        	            	Diff:
        	            	--- Expected
        	            	+++ Actual
        	            	@@ -1,2 +1,3 @@
        	            	-([]string) {
        	            	+([]string) (len=1) {
        	            	+ (string) (len=7) "sub dir"
        	            	 }
        	Test:       	TestCopyRedownload
        	Messages:   	directories
--- FAIL: TestCopyRedownload (11.65s)
=== RUN   TestSyncBasedOnCheckSum
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
2025/04/14 04:50:22 DEBUG : check sum: Need to transfer - File not found at Destination
2025/04/14 04:50:22 DEBUG : pcloud root 'rclone-test-tapuwug6tuda': Waiting for checks to finish
2025/04/14 04:50:22 DEBUG : pcloud root 'rclone-test-tapuwug6tuda': Waiting for transfers to finish
2025/04/14 04:50:22 DEBUG : check sum: sha1 = 3bc15c8aae3e4124dd409035f32ea2fd6835efc9 OK
2025/04/14 04:50:23 DEBUG : check sum.b37ac6a8.partial: renamed to: check sum
2025/04/14 04:50:23 INFO  : check sum: Copied (new)
2025/04/14 04:50:23 DEBUG : Waiting for deletions to finish
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
2025/04/14 04:50:23 DEBUG : pcloud root 'rclone-test-tapuwug6tuda': Waiting for checks to finish
2025/04/14 04:50:23 DEBUG : check sum: sha1 = 3bc15c8aae3e4124dd409035f32ea2fd6835efc9 OK
2025/04/14 04:50:23 DEBUG : check sum: Size and sha1 of src and dst objects identical
2025/04/14 04:50:23 DEBUG : check sum: Unchanged skipping
2025/04/14 04:50:23 DEBUG : pcloud root 'rclone-test-tapuwug6tuda': Waiting for transfers to finish
2025/04/14 04:50:23 DEBUG : Waiting for deletions to finish
2025/04/14 04:50:23 INFO  : There was nothing to transfer
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
--- PASS: TestSyncBasedOnCheckSum (1.37s)
=== RUN   TestSyncIgnoreErrors
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
2025/04/14 04:50:24 INFO  : d: Making directory
2025/04/14 04:50:25 DEBUG : a/potato2: Need to transfer - File not found at Destination
2025/04/14 04:50:25 DEBUG : c/non empty space: Size and modification time the same (differ by -123.456789ms, within tolerance 1s)
2025/04/14 04:50:25 DEBUG : pcloud root 'rclone-test-tapuwug6tuda': Waiting for checks to finish
2025/04/14 04:50:25 DEBUG : c/non empty space: Unchanged skipping
2025/04/14 04:50:25 DEBUG : pcloud root 'rclone-test-tapuwug6tuda': Waiting for transfers to finish
2025/04/14 04:50:25 DEBUG : a/potato2: sha1 = 9dc7f7d3279715991a22853f5981df582b7f9f6d OK
2025/04/14 04:50:25 DEBUG : a/potato2.94a2530c.partial: renamed to: a/potato2
2025/04/14 04:50:25 INFO  : a/potato2: Copied (new)
2025/04/14 04:50:25 DEBUG : Waiting for deletions to finish
2025/04/14 04:50:25 INFO  : b/potato: Deleted
2025/04/14 04:50:25 INFO  : d: Removing directory
2025/04/14 04:50:25 INFO  : b: Removing directory
2025/04/14 04:50:25 DEBUG : pcloud root 'rclone-test-tapuwug6tuda': deleted 2 directories
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
--- PASS: TestSyncIgnoreErrors (2.58s)
=== RUN   TestSyncAfterRemovingAFileAndAddingAFileSubDirWithErrors
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
2025/04/14 04:50:27 INFO  : d: Making directory
2025/04/14 04:50:28 DEBUG : c/non empty space: Size and modification time the same (differ by -123.456789ms, within tolerance 1s)
2025/04/14 04:50:28 DEBUG : a/potato2: Need to transfer - File not found at Destination
2025/04/14 04:50:28 DEBUG : pcloud root 'rclone-test-tapuwug6tuda': Waiting for checks to finish
2025/04/14 04:50:28 DEBUG : c/non empty space: Unchanged skipping
2025/04/14 04:50:28 DEBUG : pcloud root 'rclone-test-tapuwug6tuda': Waiting for transfers to finish
2025/04/14 04:50:29 DEBUG : a/potato2: sha1 = 9dc7f7d3279715991a22853f5981df582b7f9f6d OK
2025/04/14 04:50:29 DEBUG : a/potato2.94a2530c.partial: renamed to: a/potato2
2025/04/14 04:50:29 INFO  : a/potato2: Copied (new)
2025/04/14 04:50:29 ERROR : pcloud root 'rclone-test-tapuwug6tuda': not deleting files as there were IO errors
2025/04/14 04:50:29 ERROR : pcloud root 'rclone-test-tapuwug6tuda': not deleting directories as there were IO errors
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
--- PASS: TestSyncAfterRemovingAFileAndAddingAFileSubDirWithErrors (4.55s)
=== RUN   TestSyncDeleteDuring
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
2025/04/14 04:50:32 DEBUG : Waiting for deletions to finish
2025/04/14 04:50:32 DEBUG : empty space: Size and modification time the same (differ by -123.456789ms, within tolerance 1s)
2025/04/14 04:50:32 DEBUG : potato2: Need to transfer - File not found at Destination
2025/04/14 04:50:32 DEBUG : pcloud root 'rclone-test-tapuwug6tuda': Waiting for checks to finish
2025/04/14 04:50:32 DEBUG : empty space: Unchanged skipping
2025/04/14 04:50:32 DEBUG : pcloud root 'rclone-test-tapuwug6tuda': Waiting for transfers to finish
2025/04/14 04:50:32 INFO  : potato: Deleted
2025/04/14 04:50:32 DEBUG : potato2: sha1 = 9dc7f7d3279715991a22853f5981df582b7f9f6d OK
2025/04/14 04:50:32 DEBUG : potato2.94a2530c.partial: renamed to: potato2
2025/04/14 04:50:32 INFO  : potato2: Copied (new)
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
--- PASS: TestSyncDeleteDuring (2.22s)
=== RUN   TestSyncDeleteBefore
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
2025/04/14 04:50:34 DEBUG : Waiting for deletions to finish
2025/04/14 04:50:34 DEBUG : pcloud root 'rclone-test-tapuwug6tuda': Waiting for checks to finish
2025/04/14 04:50:34 DEBUG : pcloud root 'rclone-test-tapuwug6tuda': Waiting for transfers to finish
2025/04/14 04:50:34 INFO  : potato: Deleted
2025/04/14 04:50:34 DEBUG : empty space: Size and modification time the same (differ by -123.456789ms, within tolerance 1s)
2025/04/14 04:50:34 DEBUG : potato2: Need to transfer - File not found at Destination
2025/04/14 04:50:34 DEBUG : pcloud root 'rclone-test-tapuwug6tuda': Waiting for checks to finish
2025/04/14 04:50:34 DEBUG : empty space: Unchanged skipping
2025/04/14 04:50:34 DEBUG : pcloud root 'rclone-test-tapuwug6tuda': Waiting for transfers to finish
2025/04/14 04:50:34 DEBUG : potato2: sha1 = 9dc7f7d3279715991a22853f5981df582b7f9f6d OK
2025/04/14 04:50:34 DEBUG : potato2.94a2530c.partial: renamed to: potato2
2025/04/14 04:50:34 INFO  : potato2: Copied (new)
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
--- PASS: TestSyncDeleteBefore (2.22s)
=== RUN   TestSyncOverlapWithFilter
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
2025/04/14 04:50:35 DEBUG : Creating backend with remote "TestPcloud:rclone-test-tapuwug6tuda/rclone-sync-test"
2025/04/14 04:50:35 DEBUG : Config file has changed externally - reloading
2025/04/14 04:50:36 DEBUG : Creating backend with remote "TestPcloud:rclone-test-tapuwug6tuda/rclone-sync-test-include/layer2"
2025/04/14 04:50:38 DEBUG : Creating backend with remote "TestPcloud:rclone-test-tapuwug6tuda/rclone-sync-test-ignore-file"
2025/04/14 04:50:40 DEBUG : pcloud root 'rclone-test-tapuwug6tuda/rclone-sync-test': Waiting for checks to finish
2025/04/14 04:50:40 DEBUG : pcloud root 'rclone-test-tapuwug6tuda/rclone-sync-test': Waiting for transfers to finish
2025/04/14 04:50:40 DEBUG : Waiting for deletions to finish
2025/04/14 04:50:40 INFO  : There was nothing to transfer
2025/04/14 04:50:41 DEBUG : pcloud root 'rclone-test-tapuwug6tuda': Waiting for checks to finish
2025/04/14 04:50:41 DEBUG : pcloud root 'rclone-test-tapuwug6tuda': Waiting for transfers to finish
2025/04/14 04:50:41 DEBUG : Waiting for deletions to finish
2025/04/14 04:50:41 INFO  : rclone-sync-test-include: Removing directory
2025/04/14 04:50:41 DEBUG : rclone-sync-test-include: Failed to Rmdir: rmdir failed: pcloud error: Folder is not empty. (2006)
2025/04/14 04:50:41 DEBUG : pcloud root 'rclone-test-tapuwug6tuda': failed to delete 1 directories
2025/04/14 04:50:41 INFO  : There was nothing to transfer
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
2025/04/14 04:50:42 DEBUG : pcloud root 'rclone-test-tapuwug6tuda/rclone-sync-test-include/layer2': Waiting for checks to finish
2025/04/14 04:50:42 DEBUG : pcloud root 'rclone-test-tapuwug6tuda/rclone-sync-test-include/layer2': Waiting for transfers to finish
2025/04/14 04:50:42 DEBUG : Waiting for deletions to finish
2025/04/14 04:50:42 INFO  : There was nothing to transfer
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
2025/04/14 04:50:43 DEBUG : pcloud root 'rclone-test-tapuwug6tuda': Waiting for checks to finish
2025/04/14 04:50:43 DEBUG : pcloud root 'rclone-test-tapuwug6tuda': Waiting for transfers to finish
2025/04/14 04:50:43 DEBUG : Waiting for deletions to finish
2025/04/14 04:50:43 INFO  : rclone-sync-test-include: Removing directory
2025/04/14 04:50:43 DEBUG : rclone-sync-test-include: Failed to Rmdir: rmdir failed: pcloud error: Folder is not empty. (2006)
2025/04/14 04:50:43 DEBUG : pcloud root 'rclone-test-tapuwug6tuda': failed to delete 1 directories
2025/04/14 04:50:43 INFO  : There was nothing to transfer
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
2025/04/14 04:50:43 DEBUG : pcloud root 'rclone-test-tapuwug6tuda/rclone-sync-test-ignore-file': Waiting for checks to finish
2025/04/14 04:50:43 DEBUG : pcloud root 'rclone-test-tapuwug6tuda/rclone-sync-test-ignore-file': Waiting for transfers to finish
2025/04/14 04:50:43 DEBUG : Waiting for deletions to finish
2025/04/14 04:50:43 INFO  : There was nothing to transfer
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
    fstest.go:292: Sleeping for 1s for list eventual consistency: 1/3
    fstest.go:295: Flushing the directory cache
    fstest.go:286: Sleeping for 6s just to make sure
    run.go:125: removing file "sub dir/hello world" failed - try 1/3: pcloud error: File not found. (2009)
    fstest.go:292: Sleeping for 1s for list eventual consistency: 1/3
    fstest.go:295: Flushing the directory cache
    fstest.go:292: Sleeping for 2s for list eventual consistency: 2/3
    fstest.go:295: Flushing the directory cache
    fstest.go:292: Sleeping for 4s for list eventual consistency: 3/3
    fstest.go:295: Flushing the directory cache
    fstest.go:321: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:321
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:332
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:173
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:388
        	            				/home/rclone/go/pkg/mod/golang.org/toolchain@v0.0.1-go1.23.0.linux-amd64/src/testing/testing.go:1176
        	            				/home/rclone/go/pkg/mod/golang.org/toolchain@v0.0.1-go1.23.0.linux-amd64/src/testing/testing.go:1354
        	            				/home/rclone/go/pkg/mod/golang.org/toolchain@v0.0.1-go1.23.0.linux-amd64/src/testing/testing.go:1684
        	Error:      	Not equal: 
        	            	expected: []string{}
        	            	actual  : []string{"b", "c", "d"}
        	            	
        	            	Diff:
        	            	--- Expected
        	            	+++ Actual
        	            	@@ -1,2 +1,5 @@
        	            	-([]string) {
        	            	+([]string) (len=3) {
        	            	+ (string) (len=1) "b",
        	            	+ (string) (len=1) "c",
        	            	+ (string) (len=1) "d"
        	            	 }
        	Test:       	TestSyncOverlapWithFilter
        	Messages:   	directories
    run.go:125: removing file "sub dir/hello world" failed - try 1/3: pcloud error: File not found. (2009)
    run.go:125: removing dir "sub dir" failed - try 1/3: rmdir failed: pcloud error: Directory does not exist. (2005)
    run.go:125: removing dir "sub dir" failed - try 2/3: rmdir failed: pcloud error: Directory does not exist. (2005)
    run.go:125: removing dir "sub dir" failed - try 3/3: rmdir failed: pcloud error: Directory does not exist. (2005)
    run.go:128: removing dir "sub dir" failed: rmdir failed: pcloud error: Directory does not exist. (2005)
    fstest.go:292: Sleeping for 1s for list eventual consistency: 1/3
    fstest.go:295: Flushing the directory cache
    fstest.go:292: Sleeping for 2s for list eventual consistency: 2/3
    fstest.go:295: Flushing the directory cache
    fstest.go:286: Sleeping for 7s just to make sure
--- FAIL: TestSyncOverlapWithFilter (44.54s)
=== RUN   TestSyncCopyDest
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
2025/04/14 04:51:20 DEBUG : Creating backend with remote "TestPcloud:rclone-test-tapuwug6tuda/dst"
2025/04/14 04:51:20 DEBUG : Config file has changed externally - reloading
2025/04/14 04:51:21 DEBUG : Creating backend with remote "TestPcloud:rclone-test-tapuwug6tuda/CopyDest"
2025/04/14 04:51:22 DEBUG : one: Need to transfer - File not found at Destination
2025/04/14 04:51:22 DEBUG : pcloud root 'rclone-test-tapuwug6tuda/dst': Waiting for checks to finish
2025/04/14 04:51:22 DEBUG : pcloud root 'rclone-test-tapuwug6tuda/dst': Waiting for transfers to finish
2025/04/14 04:51:23 DEBUG : one: sha1 = fe05bcdcdc4928012781a5f1a2a77cbb5398e106 OK
2025/04/14 04:51:23 DEBUG : one.b824e1ab.partial: renamed to: one
2025/04/14 04:51:23 INFO  : one: Copied (new)
2025/04/14 04:51:23 DEBUG : Waiting for deletions to finish
2025/04/14 04:51:23 DEBUG : pcloud root 'rclone-test-tapuwug6tuda/dst': Waiting for checks to finish
2025/04/14 04:51:23 DEBUG : one: Sizes differ (src 5 vs dst 3)
2025/04/14 04:51:23 DEBUG : pcloud root 'rclone-test-tapuwug6tuda/dst': Waiting for transfers to finish
2025/04/14 04:51:23 DEBUG : one: sha1 = 7f376fd65843a1267de8f986d40e164e5a321c13 OK
2025/04/14 04:51:23 DEBUG : one.406dcb2c.partial: renamed to: one
2025/04/14 04:51:23 INFO  : one: Copied (replaced existing)
2025/04/14 04:51:23 DEBUG : Waiting for deletions to finish
2025/04/14 04:51:24 DEBUG : Creating backend with remote "TestPcloud:rclone-test-tapuwug6tuda/BackupDir"
2025/04/14 04:51:25 DEBUG : one: Sizes differ (src 5 vs dst 3)
2025/04/14 04:51:25 DEBUG : pcloud root 'rclone-test-tapuwug6tuda/dst': Waiting for checks to finish
2025/04/14 04:51:25 DEBUG : one: Size and modification time the same (differ by -123.456789ms, within tolerance 1s)
2025/04/14 04:51:25 DEBUG : one: Sizes differ (src 5 vs dst 3)
2025/04/14 04:51:26 INFO  : one: Moved (server-side)
2025/04/14 04:51:26 DEBUG : one: sha1 = 7f376fd65843a1267de8f986d40e164e5a321c13 OK
2025/04/14 04:51:26 DEBUG : one.d88fe5df.partial: renamed to: one
2025/04/14 04:51:26 INFO  : one: Copied (server-side copy)
2025/04/14 04:51:26 DEBUG : one: Destination found in --copy-dest, using server-side copy
2025/04/14 04:51:26 DEBUG : pcloud root 'rclone-test-tapuwug6tuda/dst': Waiting for transfers to finish
2025/04/14 04:51:26 DEBUG : Waiting for deletions to finish
2025/04/14 04:51:27 DEBUG : one: Size and modification time the same (differ by -123.456789ms, within tolerance 1s)
2025/04/14 04:51:27 DEBUG : one: Unchanged skipping
2025/04/14 04:51:27 DEBUG : two: Size and modification time the same (differ by -123.456789ms, within tolerance 1s)
2025/04/14 04:51:27 DEBUG : two: sha1 = ad782ecdac770fc6eb9a62e44f90873fb97fb26b OK
2025/04/14 04:51:27 DEBUG : two.19d5dbaa.partial: renamed to: two
2025/04/14 04:51:27 INFO  : two: Copied (server-side copy)
2025/04/14 04:51:27 DEBUG : two: Destination found in --copy-dest, using server-side copy
2025/04/14 04:51:27 DEBUG : pcloud root 'rclone-test-tapuwug6tuda/dst': Waiting for checks to finish
2025/04/14 04:51:27 DEBUG : pcloud root 'rclone-test-tapuwug6tuda/dst': Waiting for transfers to finish
2025/04/14 04:51:27 DEBUG : Waiting for deletions to finish
2025/04/14 04:51:28 DEBUG : one: Size and modification time the same (differ by -123.456789ms, within tolerance 1s)
2025/04/14 04:51:28 DEBUG : one: Unchanged skipping
2025/04/14 04:51:28 DEBUG : two: Size and modification time the same (differ by -123.456789ms, within tolerance 1s)
2025/04/14 04:51:28 DEBUG : two: Unchanged skipping
2025/04/14 04:51:28 DEBUG : pcloud root 'rclone-test-tapuwug6tuda/dst': Waiting for checks to finish
2025/04/14 04:51:28 DEBUG : pcloud root 'rclone-test-tapuwug6tuda/dst': Waiting for transfers to finish
2025/04/14 04:51:28 DEBUG : Waiting for deletions to finish
2025/04/14 04:51:28 INFO  : There was nothing to transfer
2025/04/14 04:51:29 DEBUG : one: Size and modification time the same (differ by -123.456789ms, within tolerance 1s)
2025/04/14 04:51:29 DEBUG : one: Unchanged skipping
2025/04/14 04:51:29 DEBUG : three: Sizes differ (src 7 vs dst 5)
2025/04/14 04:51:29 DEBUG : three: Destination not found in --copy-dest
2025/04/14 04:51:29 DEBUG : three: Need to transfer - File not found at Destination
2025/04/14 04:51:29 DEBUG : two: Size and modification time the same (differ by -123.456789ms, within tolerance 1s)
2025/04/14 04:51:29 DEBUG : two: Unchanged skipping
2025/04/14 04:51:29 DEBUG : pcloud root 'rclone-test-tapuwug6tuda/dst': Waiting for checks to finish
2025/04/14 04:51:29 DEBUG : pcloud root 'rclone-test-tapuwug6tuda/dst': Waiting for transfers to finish
2025/04/14 04:51:30 DEBUG : three: sha1 = 370e613335f3cf2f19b2a2d35a86402f55c659f8 OK
2025/04/14 04:51:30 DEBUG : three.8cc66b1.partial: renamed to: three
2025/04/14 04:51:30 INFO  : three: Copied (new)
2025/04/14 04:51:30 DEBUG : Waiting for deletions to finish
--- PASS: TestSyncCopyDest (11.50s)
=== RUN   TestSyncBackupDir
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
2025/04/14 04:51:32 DEBUG : Creating backend with remote "TestPcloud:rclone-test-tapuwug6tuda/dst"
2025/04/14 04:51:33 DEBUG : Creating backend with remote "TestPcloud:rclone-test-tapuwug6tuda/backup"
2025/04/14 04:51:33 DEBUG : one: Sizes differ (src 4 vs dst 3)
2025/04/14 04:51:33 DEBUG : two: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2025/04/14 04:51:33 DEBUG : two: Unchanged skipping
2025/04/14 04:51:33 DEBUG : pcloud root 'rclone-test-tapuwug6tuda/dst': Waiting for checks to finish
2025/04/14 04:51:34 INFO  : one: Moved (server-side)
2025/04/14 04:51:34 DEBUG : pcloud root 'rclone-test-tapuwug6tuda/dst': Waiting for transfers to finish
2025/04/14 04:51:34 DEBUG : one: sha1 = d63a9910ed57f038b76549c070df6196b2102f42 OK
2025/04/14 04:51:34 DEBUG : one.a87a5b8d.partial: renamed to: one
2025/04/14 04:51:34 INFO  : one: Copied (new)
2025/04/14 04:51:34 DEBUG : Waiting for deletions to finish
2025/04/14 04:51:34 INFO  : three.txt: Moved (server-side)
2025/04/14 04:51:34 INFO  : three.txt: Moved into backup dir
2025/04/14 04:51:35 DEBUG : one: Sizes differ (src 5 vs dst 4)
2025/04/14 04:51:35 DEBUG : two: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2025/04/14 04:51:35 DEBUG : two: Unchanged skipping
2025/04/14 04:51:35 DEBUG : pcloud root 'rclone-test-tapuwug6tuda/dst': Waiting for checks to finish
2025/04/14 04:51:35 INFO  : one: Deleted
2025/04/14 04:51:35 INFO  : one: Moved (server-side)
2025/04/14 04:51:35 DEBUG : pcloud root 'rclone-test-tapuwug6tuda/dst': Waiting for transfers to finish
2025/04/14 04:51:36 DEBUG : one: sha1 = 88a8c2880f555638f990d1ec4c8359b25caa20c7 OK
2025/04/14 04:51:36 DEBUG : one.1503b713.partial: renamed to: one
2025/04/14 04:51:36 INFO  : one: Copied (new)
2025/04/14 04:51:36 DEBUG : Waiting for deletions to finish
2025/04/14 04:51:36 INFO  : three.txt: Deleted
2025/04/14 04:51:36 INFO  : three.txt: Moved (server-side)
2025/04/14 04:51:36 INFO  : three.txt: Moved into backup dir
--- PASS: TestSyncBackupDir (6.04s)
=== RUN   TestSyncBackupDirWithSuffix
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
2025/04/14 04:51:38 DEBUG : Creating backend with remote "TestPcloud:rclone-test-tapuwug6tuda/dst"
2025/04/14 04:51:39 DEBUG : Creating backend with remote "TestPcloud:rclone-test-tapuwug6tuda/backup"
2025/04/14 04:51:39 DEBUG : one: Sizes differ (src 4 vs dst 3)
2025/04/14 04:51:39 DEBUG : pcloud root 'rclone-test-tapuwug6tuda/dst': Waiting for checks to finish
2025/04/14 04:51:39 DEBUG : two: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2025/04/14 04:51:39 DEBUG : two: Unchanged skipping
2025/04/14 04:51:40 INFO  : one: Moved (server-side) to: one.bak
2025/04/14 04:51:40 DEBUG : pcloud root 'rclone-test-tapuwug6tuda/dst': Waiting for transfers to finish
2025/04/14 04:51:40 DEBUG : one: sha1 = d63a9910ed57f038b76549c070df6196b2102f42 OK
2025/04/14 04:51:40 DEBUG : one.a87a5b8d.partial: renamed to: one
2025/04/14 04:51:40 INFO  : one: Copied (new)
2025/04/14 04:51:40 DEBUG : Waiting for deletions to finish
2025/04/14 04:51:40 INFO  : three.txt: Moved (server-side) to: three.txt.bak
2025/04/14 04:51:40 INFO  : three.txt: Moved into backup dir
2025/04/14 04:51:41 DEBUG : one: Sizes differ (src 5 vs dst 4)
2025/04/14 04:51:41 DEBUG : two: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2025/04/14 04:51:41 DEBUG : two: Unchanged skipping
2025/04/14 04:51:41 DEBUG : pcloud root 'rclone-test-tapuwug6tuda/dst': Waiting for checks to finish
2025/04/14 04:51:42 INFO  : one.bak: Deleted
2025/04/14 04:51:42 INFO  : one: Moved (server-side) to: one.bak
2025/04/14 04:51:42 DEBUG : pcloud root 'rclone-test-tapuwug6tuda/dst': Waiting for transfers to finish
2025/04/14 04:51:42 DEBUG : one: sha1 = 88a8c2880f555638f990d1ec4c8359b25caa20c7 OK
2025/04/14 04:51:42 DEBUG : one.1503b713.partial: renamed to: one
2025/04/14 04:51:42 INFO  : one: Copied (new)
2025/04/14 04:51:42 DEBUG : Waiting for deletions to finish
2025/04/14 04:51:42 INFO  : three.txt.bak: Deleted
2025/04/14 04:51:42 INFO  : three.txt: Moved (server-side) to: three.txt.bak
2025/04/14 04:51:42 INFO  : three.txt: Moved into backup dir
    fstest.go:292: Sleeping for 1s for list eventual consistency: 1/3
    fstest.go:295: Flushing the directory cache
    fstest.go:286: Sleeping for 6s just to make sure
--- PASS: TestSyncBackupDirWithSuffix (12.80s)
=== RUN   TestSyncSuffixKeepExtension
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
    run.go:285: Failed to put "dst/one" to "pcloud root 'rclone-test-tapuwug6tuda'": failed to make directory: pcloud error: File or folder already exists. (2004)
--- FAIL: TestSyncSuffixKeepExtension (0.48s)
=== RUN   TestSyncUTFNorm
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
    fstest.go:292: Sleeping for 1s for list eventual consistency: 1/3
    fstest.go:295: Flushing the directory cache
    fstest.go:292: Sleeping for 2s for list eventual consistency: 2/3
    fstest.go:295: Flushing the directory cache
    fstest.go:292: Sleeping for 4s for list eventual consistency: 3/3
    fstest.go:295: Flushing the directory cache
    fstest.go:299: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:299
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:332
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:344
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:340
        	            				/home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2545
        	Error:      	Should be true
        	Test:       	TestSyncUTFNorm
        	Messages:   	listing wrong, want
        	            	  Testêé (18) got
        	            	  
    fstest.go:197: Not found "Testêé"
    fstest.go:200: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:200
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:304
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:332
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:344
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:340
        	            				/home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2545
        	Error:      	Not equal: 
        	            	expected: 0
        	            	actual  : 1
        	Test:       	TestSyncUTFNorm
        	Messages:   	1 objects not found
2025/04/14 04:51:59 DEBUG : Testêé: Need to transfer - File not found at Destination
2025/04/14 04:51:59 DEBUG : pcloud root 'rclone-test-tapuwug6tuda': Waiting for checks to finish
2025/04/14 04:51:59 DEBUG : pcloud root 'rclone-test-tapuwug6tuda': Waiting for transfers to finish
2025/04/14 04:51:59 DEBUG : Testêé: sha1 = a54d88e06612d820bc3be72877c74f257b561b19 OK
2025/04/14 04:51:59 DEBUG : Testêé.53508f02.partial: renamed to: Testêé
2025/04/14 04:51:59 INFO  : Testêé: Copied (new)
2025/04/14 04:51:59 DEBUG : Waiting for deletions to finish
    fstest.go:292: Sleeping for 1s for list eventual consistency: 1/3
    fstest.go:295: Flushing the directory cache
    fstest.go:292: Sleeping for 2s for list eventual consistency: 2/3
    fstest.go:295: Flushing the directory cache
    fstest.go:292: Sleeping for 4s for list eventual consistency: 3/3
    fstest.go:295: Flushing the directory cache
    fstest.go:299: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:299
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:332
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:344
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:340
        	            				/home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2558
        	Error:      	Should be true
        	Test:       	TestSyncUTFNorm
        	Messages:   	listing wrong, want
        	            	  Testêé (14) got
        	            	  
    fstest.go:197: Not found "Testêé"
    fstest.go:200: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:200
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:304
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:332
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:344
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:340
        	            				/home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2558
        	Error:      	Not equal: 
        	            	expected: 0
        	            	actual  : 1
        	Test:       	TestSyncUTFNorm
        	Messages:   	1 objects not found
--- FAIL: TestSyncUTFNorm (17.50s)
=== RUN   TestSyncConcurrentTruncate
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
    fstest.go:292: Sleeping for 1s for list eventual consistency: 1/3
    fstest.go:295: Flushing the directory cache
    fstest.go:292: Sleeping for 2s for list eventual consistency: 2/3
    fstest.go:295: Flushing the directory cache
    fstest.go:292: Sleeping for 4s for list eventual consistency: 3/3
    fstest.go:295: Flushing the directory cache
    fstest.go:299: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:299
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:332
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:344
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:340
        	            				/home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2744
        	            				/home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2762
        	Error:      	Should be true
        	Test:       	TestSyncConcurrentTruncate
        	Messages:   	listing wrong, want
        	            	  both0 (6), both1 (6), both10 (6), both11 (6), both12 (6), both13 (6), both14 (6), both15 (6), both16 (6), both17 (6), both18 (6), both19 (6), both2 (6), both3 (6), both4 (6), both5 (6), both6 (6), both7 (6), both8 (6), both9 (6), only0 (6), only1 (6), only10 (6), only11 (6), only12 (6), only13 (6), only14 (6), only15 (6), only16 (6), only17 (6), only18 (6), only19 (6), only2 (6), only3 (6), only4 (6), only5 (6), only6 (6), only7 (6), only8 (6), only9 (6) got
        	            	  Testêé (18), backup/one.bak (4), backup/three.txt.bak (6), dst/one (5), dst/two (3)
    fstest.go:185: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:185
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:302
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:332
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:344
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:340
        	            				/home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2744
        	            				/home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2762
        	Error:      	Should be true
        	Test:       	TestSyncConcurrentTruncate
        	Messages:   	Unexpected file "backup/one.bak"
    fstest.go:185: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:185
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:302
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:332
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:344
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:340
        	            				/home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2744
        	            				/home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2762
        	Error:      	Should be true
        	Test:       	TestSyncConcurrentTruncate
        	Messages:   	Unexpected file "backup/three.txt.bak"
    fstest.go:185: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:185
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:302
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:332
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:344
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:340
        	            				/home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2744
        	            				/home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2762
        	Error:      	Should be true
        	Test:       	TestSyncConcurrentTruncate
        	Messages:   	Unexpected file "dst/one"
    fstest.go:185: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:185
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:302
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:332
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:344
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:340
        	            				/home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2744
        	            				/home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2762
        	Error:      	Should be true
        	Test:       	TestSyncConcurrentTruncate
        	Messages:   	Unexpected file "dst/two"
    fstest.go:185: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:185
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:302
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:332
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:344
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:340
        	            				/home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2744
        	            				/home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2762
        	Error:      	Should be true
        	Test:       	TestSyncConcurrentTruncate
        	Messages:   	Unexpected file "Testêé"
    fstest.go:197: Not found "only2"
    fstest.go:197: Not found "both3"
    fstest.go:197: Not found "both8"
    fstest.go:197: Not found "both12"
    fstest.go:197: Not found "both14"
    fstest.go:197: Not found "only14"
    fstest.go:197: Not found "only19"
    fstest.go:197: Not found "only11"
    fstest.go:197: Not found "both1"
    fstest.go:197: Not found "only5"
    fstest.go:197: Not found "only6"
    fstest.go:197: Not found "only9"
    fstest.go:197: Not found "both15"
    fstest.go:197: Not found "only16"
    fstest.go:197: Not found "only3"
    fstest.go:197: Not found "both4"
    fstest.go:197: Not found "both6"
    fstest.go:197: Not found "only7"
    fstest.go:197: Not found "only8"
    fstest.go:197: Not found "both13"
    fstest.go:197: Not found "only0"
    fstest.go:197: Not found "both2"
    fstest.go:197: Not found "only10"
    fstest.go:197: Not found "only15"
    fstest.go:197: Not found "both17"
    fstest.go:197: Not found "both18"
    fstest.go:197: Not found "both19"
    fstest.go:197: Not found "both0"
    fstest.go:197: Not found "only1"
    fstest.go:197: Not found "both5"
    fstest.go:197: Not found "both7"
    fstest.go:197: Not found "both9"
    fstest.go:197: Not found "only18"
    fstest.go:197: Not found "only4"
    fstest.go:197: Not found "both10"
    fstest.go:197: Not found "only12"
    fstest.go:197: Not found "both16"
    fstest.go:197: Not found "only17"
    fstest.go:197: Not found "both11"
    fstest.go:197: Not found "only13"
    fstest.go:200: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:200
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:304
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:332
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:344
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/run.go:340
        	            				/home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2744
        	            				/home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2762
        	Error:      	Not equal: 
        	            	expected: 0
        	            	actual  : 40
        	Test:       	TestSyncConcurrentTruncate
        	Messages:   	40 objects not found
2025/04/14 04:52:22 DEBUG : both0: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : both1: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : both10: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : both11: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : both12: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : both13: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : both14: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : both15: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : both16: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : both17: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : both18: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : both19: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : both2: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : both3: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : both4: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : both5: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : both6: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : both7: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : both8: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : both9: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : only0: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : only1: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : only10: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : only11: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : only12: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : only13: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : only14: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : only15: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : only16: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : only17: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : only18: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : only19: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : only2: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : only3: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : only4: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : only5: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : only6: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : only7: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : only8: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : only9: Need to transfer - File not found at Destination
2025/04/14 04:52:22 DEBUG : pcloud root 'rclone-test-tapuwug6tuda': Waiting for checks to finish
2025/04/14 04:52:22 DEBUG : pcloud root 'rclone-test-tapuwug6tuda': Waiting for transfers to finish
2025/04/14 04:52:22 DEBUG : both1: sha1 = 3e2e95f5ad970eadfa7e17eaf73da97024aa5359 OK
2025/04/14 04:52:22 DEBUG : both1.468f3f0c.partial: renamed to: both1
2025/04/14 04:52:22 INFO  : both1: Copied (new)
2025/04/14 04:52:22 DEBUG : both12: sha1 = 3e2e95f5ad970eadfa7e17eaf73da97024aa5359 OK
2025/04/14 04:52:22 DEBUG : both0: sha1 = 3e2e95f5ad970eadfa7e17eaf73da97024aa5359 OK
2025/04/14 04:52:22 DEBUG : both10: sha1 = 3e2e95f5ad970eadfa7e17eaf73da97024aa5359 OK
2025/04/14 04:52:22 DEBUG : both12.468f3f0c.partial: renamed to: both12
2025/04/14 04:52:22 INFO  : both12: Copied (new)
2025/04/14 04:52:22 DEBUG : both11: sha1 = 3e2e95f5ad970eadfa7e17eaf73da97024aa5359 OK
2025/04/14 04:52:22 DEBUG : both0.468f3f0c.partial: renamed to: both0
2025/04/14 04:52:22 INFO  : both0: Copied (new)
2025/04/14 04:52:22 DEBUG : both11.468f3f0c.partial: renamed to: both11
2025/04/14 04:52:22 INFO  : both11: Copied (new)
2025/04/14 04:52:22 DEBUG : both13: sha1 = 3e2e95f5ad970eadfa7e17eaf73da97024aa5359 OK
2025/04/14 04:52:22 DEBUG : both14: sha1 = 3e2e95f5ad970eadfa7e17eaf73da97024aa5359 OK
2025/04/14 04:52:22 DEBUG : both15: sha1 = 3e2e95f5ad970eadfa7e17eaf73da97024aa5359 OK
2025/04/14 04:52:22 DEBUG : both13.468f3f0c.partial: renamed to: both13
2025/04/14 04:52:22 INFO  : both13: Copied (new)
2025/04/14 04:52:22 DEBUG : both14.468f3f0c.partial: renamed to: both14
2025/04/14 04:52:22 INFO  : both14: Copied (new)
2025/04/14 04:52:22 DEBUG : both10.468f3f0c.partial: renamed to: both10
2025/04/14 04:52:22 INFO  : both10: Copied (new)
2025/04/14 04:52:23 DEBUG : both15.468f3f0c.partial: renamed to: both15
2025/04/14 04:52:23 INFO  : both15: Copied (new)
2025/04/14 04:52:23 DEBUG : both16: sha1 = 3e2e95f5ad970eadfa7e17eaf73da97024aa5359 OK
2025/04/14 04:52:23 DEBUG : both17: sha1 = 3e2e95f5ad970eadfa7e17eaf73da97024aa5359 OK
2025/04/14 04:52:23 DEBUG : both18: sha1 = 3e2e95f5ad970eadfa7e17eaf73da97024aa5359 OK
2025/04/14 04:52:23 DEBUG : both19: sha1 = 3e2e95f5ad970eadfa7e17eaf73da97024aa5359 OK
2025/04/14 04:52:23 DEBUG : both16.468f3f0c.partial: renamed to: both16
2025/04/14 04:52:23 INFO  : both16: Copied (new)
2025/04/14 04:52:23 DEBUG : both17.468f3f0c.partial: renamed to: both17
2025/04/14 04:52:23 INFO  : both17: Copied (new)
2025/04/14 04:52:23 DEBUG : both18.468f3f0c.partial: renamed to: both18
2025/04/14 04:52:23 INFO  : both18: Copied (new)
2025/04/14 04:52:23 DEBUG : both19.468f3f0c.partial: renamed to: both19
2025/04/14 04:52:23 INFO  : both19: Copied (new)
2025/04/14 04:52:23 DEBUG : both2: sha1 = 3e2e95f5ad970eadfa7e17eaf73da97024aa5359 OK
2025/04/14 04:52:23 DEBUG : both3: sha1 = 3e2e95f5ad970eadfa7e17eaf73da97024aa5359 OK
2025/04/14 04:52:23 DEBUG : both4: sha1 = 3e2e95f5ad970eadfa7e17eaf73da97024aa5359 OK
2025/04/14 04:52:23 DEBUG : both5: sha1 = 3e2e95f5ad970eadfa7e17eaf73da97024aa5359 OK
2025/04/14 04:52:23 DEBUG : both2.468f3f0c.partial: renamed to: both2
2025/04/14 04:52:23 INFO  : both2: Copied (new)
2025/04/14 04:52:23 DEBUG : both3.468f3f0c.partial: renamed to: both3
2025/04/14 04:52:23 INFO  : both3: Copied (new)
2025/04/14 04:52:23 DEBUG : both4.468f3f0c.partial: renamed to: both4
2025/04/14 04:52:23 INFO  : both4: Copied (new)
2025/04/14 04:52:23 DEBUG : both5.468f3f0c.partial: renamed to: both5
2025/04/14 04:52:23 INFO  : both5: Copied (new)
2025/04/14 04:52:23 DEBUG : both7: sha1 = 3e2e95f5ad970eadfa7e17eaf73da97024aa5359 OK
2025/04/14 04:52:23 DEBUG : both8: sha1 = 3e2e95f5ad970eadfa7e17eaf73da97024aa5359 OK
2025/04/14 04:52:23 DEBUG : both6: sha1 = 3e2e95f5ad970eadfa7e17eaf73da97024aa5359 OK
2025/04/14 04:52:23 DEBUG : both9: sha1 = 3e2e95f5ad970eadfa7e17eaf73da97024aa5359 OK
2025/04/14 04:52:23 DEBUG : both7.468f3f0c.partial: renamed to: both7
2025/04/14 04:52:23 INFO  : both7: Copied (new)
2025/04/14 04:52:23 DEBUG : both8.468f3f0c.partial: renamed to: both8
2025/04/14 04:52:23 INFO  : both8: Copied (new)
2025/04/14 04:52:23 DEBUG : both6.468f3f0c.partial: renamed to: both6
2025/04/14 04:52:23 INFO  : both6: Copied (new)
2025/04/14 04:52:23 DEBUG : both9.468f3f0c.partial: renamed to: both9
2025/04/14 04:52:23 INFO  : both9: Copied (new)
2025/04/14 04:52:23 DEBUG : only1: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK
2025/04/14 04:52:23 DEBUG : only0: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK
2025/04/14 04:52:23 DEBUG : only11: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK
2025/04/14 04:52:23 DEBUG : only1.5b6d5609.partial: renamed to: only1
2025/04/14 04:52:23 INFO  : only1: Copied (new)
2025/04/14 04:52:23 DEBUG : only0.5b6d5609.partial: renamed to: only0
2025/04/14 04:52:23 INFO  : only0: Copied (new)
2025/04/14 04:52:23 DEBUG : only11.5b6d5609.partial: renamed to: only11
2025/04/14 04:52:23 INFO  : only11: Copied (new)
2025/04/14 04:52:23 DEBUG : only12: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK
2025/04/14 04:52:23 DEBUG : only13: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK
2025/04/14 04:52:23 DEBUG : only10: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK
2025/04/14 04:52:23 DEBUG : only12.5b6d5609.partial: renamed to: only12
2025/04/14 04:52:23 INFO  : only12: Copied (new)
2025/04/14 04:52:23 DEBUG : only13.5b6d5609.partial: renamed to: only13
2025/04/14 04:52:23 INFO  : only13: Copied (new)
2025/04/14 04:52:23 DEBUG : only14: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK
2025/04/14 04:52:24 DEBUG : only10.5b6d5609.partial: renamed to: only10
2025/04/14 04:52:24 INFO  : only10: Copied (new)
2025/04/14 04:52:24 DEBUG : only15: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK
2025/04/14 04:52:24 DEBUG : only14.5b6d5609.partial: renamed to: only14
2025/04/14 04:52:24 INFO  : only14: Copied (new)
2025/04/14 04:52:24 DEBUG : only17: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK
2025/04/14 04:52:24 DEBUG : only15.5b6d5609.partial: renamed to: only15
2025/04/14 04:52:24 INFO  : only15: Copied (new)
2025/04/14 04:52:24 DEBUG : only18: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK
2025/04/14 04:52:24 DEBUG : only17.5b6d5609.partial: renamed to: only17
2025/04/14 04:52:24 INFO  : only17: Copied (new)
2025/04/14 04:52:24 DEBUG : only18.5b6d5609.partial: renamed to: only18
2025/04/14 04:52:24 INFO  : only18: Copied (new)
2025/04/14 04:52:24 DEBUG : only16: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK
2025/04/14 04:52:24 DEBUG : only2: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK
2025/04/14 04:52:24 DEBUG : only3: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK
2025/04/14 04:52:24 DEBUG : only16.5b6d5609.partial: renamed to: only16
2025/04/14 04:52:24 INFO  : only16: Copied (new)
2025/04/14 04:52:24 DEBUG : only2.5b6d5609.partial: renamed to: only2
2025/04/14 04:52:24 INFO  : only2: Copied (new)
2025/04/14 04:52:24 DEBUG : only3.5b6d5609.partial: renamed to: only3
2025/04/14 04:52:24 INFO  : only3: Copied (new)
2025/04/14 04:52:24 DEBUG : only19: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK
2025/04/14 04:52:24 DEBUG : only4: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK
2025/04/14 04:52:24 DEBUG : only19.5b6d5609.partial: renamed to: only19
2025/04/14 04:52:24 INFO  : only19: Copied (new)
2025/04/14 04:52:24 DEBUG : only6: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK
2025/04/14 04:52:24 DEBUG : only4.5b6d5609.partial: renamed to: only4
2025/04/14 04:52:24 INFO  : only4: Copied (new)
2025/04/14 04:52:24 DEBUG : only5: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK
2025/04/14 04:52:24 DEBUG : only7: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK
2025/04/14 04:52:24 DEBUG : only6.5b6d5609.partial: renamed to: only6
2025/04/14 04:52:24 INFO  : only6: Copied (new)
2025/04/14 04:52:24 DEBUG : only8: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK
2025/04/14 04:52:24 DEBUG : only5.5b6d5609.partial: renamed to: only5
2025/04/14 04:52:24 INFO  : only5: Copied (new)
2025/04/14 04:52:24 DEBUG : only7.5b6d5609.partial: renamed to: only7
2025/04/14 04:52:24 INFO  : only7: Copied (new)
2025/04/14 04:52:24 DEBUG : only9: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK
2025/04/14 04:52:24 DEBUG : only8.5b6d5609.partial: renamed to: only8
2025/04/14 04:52:24 INFO  : only8: Copied (new)
2025/04/14 04:52:24 DEBUG : only9.5b6d5609.partial: renamed to: only9
2025/04/14 04:52:24 INFO  : only9: Copied (new)
2025/04/14 04:52:24 DEBUG : Waiting for deletions to finish
2025/04/14 04:52:25 ERROR : backup/one.bak: Couldn't delete: pcloud error: File not found. (2009)
2025/04/14 04:52:25 ERROR : backup/three.txt.bak: Couldn't delete: pcloud error: File not found. (2009)
2025/04/14 04:52:25 ERROR : Testêé: Couldn't delete: pcloud error: File not found. (2009)
2025/04/14 04:52:25 ERROR : dst/one: Couldn't delete: pcloud error: File not found. (2009)
2025/04/14 04:52:25 ERROR : dst/two: Couldn't delete: pcloud error: File not found. (2009)
2025/04/14 04:52:25 ERROR : pcloud root 'rclone-test-tapuwug6tuda': not deleting directories as there were IO errors
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
    sync_test.go:2752: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2752
        	            				/home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2762
        	Error:      	Received unexpected error:
        	            	failed to delete 5 files
        	Test:       	TestSyncConcurrentTruncate
        	Messages:   	Sync must not return a error
    sync_test.go:2753: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2753
        	            				/home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2762
        	Error:      	Should be false
        	Test:       	TestSyncConcurrentTruncate
        	Messages:   	Low level errors must not have happened
--- FAIL: TestSyncConcurrentTruncate (24.91s)
=== RUN   TestSyncReplaceDirModTime
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
2025/04/14 04:52:33 DEBUG : empty_dir: Making directory with metadata
2025/04/14 04:52:33 INFO  : empty_dir: Made directory with metadata (mtime=2011-12-25T12:59:59.123456789Z)
2025/04/14 04:52:33 DEBUG : empty_on_remote: Making directory with metadata
2025/04/14 04:52:33 INFO  : empty_on_remote: Made directory with metadata (mtime=2011-12-25T12:59:59.123456789Z)
2025/04/14 04:52:33 INFO  : empty_on_remote: Making directory
2025/04/14 04:52:34 INFO  : empty_on_remote: Made directory with modification time 2011-12-25 12:59:59.123456789 +0000 UTC
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
2025/04/14 04:52:34 INFO  : test_dir1: Set directory modification time (using DirSetModTime)
2025/04/14 04:52:34 INFO  : test_dir2: Set directory modification time (using DirSetModTime)
2025/04/14 04:52:34 INFO  : test_dir2/sub_dir: Set directory modification time (using DirSetModTime)
2025/04/14 04:52:34 INFO  : empty_on_remote: Set directory modification time (using DirSetModTime)
    run.go:180: Remote "pcloud root 'rclone-test-tapuwug6tuda'", Local "Local file system at /tmp/rclone1185247972", Modify Window "1s"
--- PASS: TestSyncReplaceDirModTime (2.92s)
FAIL
2025/04/14 04:52:36 DEBUG : pcloud root 'rclone-test-tapuwug6tuda': Purge remote
"./sync.test -test.v -test.timeout 1h0m0s -remote TestPcloud: -verbose -fast-list -test.run '^(TestCopyAfterDelete|TestCopyRedownload|TestMoveOverSelf|TestServerSideCopyOverSelf|TestServerSideMoveOverSelf|TestSyncAfterRemovingAFileAndAddingAFileSubDirWithErrors|TestSyncBackupDir|TestSyncBackupDirWithSuffix|TestSyncBasedOnCheckSum|TestSyncConcurrentTruncate|TestSyncCopyDest|TestSyncDeleteBefore|TestSyncDeleteDuring|TestSyncIgnoreErrors|TestSyncOverlapWithFilter|TestSyncReplaceDirModTime|TestSyncSuffixKeepExtension|TestSyncUTFNorm)$'" - Finished ERROR in 2m55.793550881s (try 3/5): exit status 1: Failed [TestServerSideMoveOverSelf TestCopyRedownload TestSyncOverlapWithFilter TestSyncSuffixKeepExtension TestSyncUTFNorm TestSyncConcurrentTruncate]