"./operations.test -test.v -test.timeout 1h0m0s -remote TestOpenDrive: -verbose -test.run '^(TestCheckSizeOnly|TestPurge|TestRemoveExisting|TestRmdirsLeaveRoot)$'" - Starting (try 2/5)
2025/04/03 02:47:48 DEBUG : Creating backend with remote "TestOpenDrive:rclone-test-sajerek2homi"
2025/04/03 02:47:48 DEBUG : Using config file from "/home/rclone/.rclone.conf"
2025/04/03 02:47:49 DEBUG : Starting OpenDrive session with ID: cb6040be9f75685f6dbcbcb2e3a19b9519647c2f8ae22790f71e819c337337a2
2025/04/03 02:47:49 DEBUG : Creating backend with remote "/tmp/rclone306894911"
=== RUN   TestCheckSizeOnly
    run.go:180: Remote "OpenDrive root 'rclone-test-sajerek2homi'", Local "Local file system at /tmp/rclone306894911", Modify Window "1s"
2025/04/03 02:47:50 DEBUG : rutabaga: Uploading chunk 0, size=8, remain=0
=== RUN   TestCheckSizeOnly/1
=== RUN   TestCheckSizeOnly/2
2025/04/03 02:47:53 DEBUG : empty space: Uploading chunk 0, size=1, remain=0
=== RUN   TestCheckSizeOnly/3
2025/04/03 02:47:55 DEBUG : potato2: Uploading chunk 0, size=60, remain=0
=== RUN   TestCheckSizeOnly/4
=== RUN   TestCheckSizeOnly/5
2025/04/03 02:47:58 DEBUG : remotepotato: Uploading chunk 0, size=60, remain=0
=== RUN   TestCheckSizeOnly/6
=== RUN   TestCheckSizeOnly/7
--- PASS: TestCheckSizeOnly (11.69s)
    --- PASS: TestCheckSizeOnly/1 (0.21s)
    --- PASS: TestCheckSizeOnly/2 (0.21s)
    --- PASS: TestCheckSizeOnly/3 (0.20s)
    --- PASS: TestCheckSizeOnly/4 (0.21s)
    --- PASS: TestCheckSizeOnly/5 (0.21s)
    --- PASS: TestCheckSizeOnly/6 (0.21s)
    --- PASS: TestCheckSizeOnly/7 (0.21s)
=== RUN   TestPurge
2025/04/03 02:48:01 DEBUG : Creating backend with remote "TestOpenDrive:rclone-test-qologib4muqo"
2025/04/03 02:48:01 DEBUG : Using config file from "/home/rclone/.rclone.conf"
2025/04/03 02:48:01 DEBUG : Starting OpenDrive session with ID: 56efb2e987b9f23f14cc66a573648910b141065075d48b9e92b6861ac91f139b
2025/04/03 02:48:02 DEBUG : Creating backend with remote "/tmp/rclone2922671594"
    run.go:180: Remote "OpenDrive root 'rclone-test-qologib4muqo'", Local "Local file system at /tmp/rclone2922671594", Modify Window "1s"
2025/04/03 02:48:04 DEBUG : A1/B1/C1/one: Uploading chunk 0, size=3, remain=0
2025/04/03 02:48:05 INFO  : A2: Making directory
2025/04/03 02:48:05 INFO  : A1/B2: Making directory
2025/04/03 02:48:05 INFO  : A1/B2/C2: Making directory
2025/04/03 02:48:06 INFO  : A1/B1/C3: Making directory
2025/04/03 02:48:06 INFO  : A3: Making directory
2025/04/03 02:48:06 INFO  : A3/B3: Making directory
2025/04/03 02:48:07 INFO  : A3/B3/C4: Making directory
2025/04/03 02:48:08 DEBUG : A1/two: Uploading chunk 0, size=3, remain=0
    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
2025/04/03 02:48:20 ERROR : : error listing: directory not found
2025/04/03 02:48:20 DEBUG : OpenDrive root 'rclone-test-qologib4muqo': Purge remote
2025/04/03 02:48:20 NOTICE: purge failed: directory not found
--- PASS: TestPurge (19.41s)
=== RUN   TestRmdirsLeaveRoot
    run.go:180: Remote "OpenDrive root 'rclone-test-sajerek2homi'", Local "Local file system at /tmp/rclone306894911", Modify Window "1s"
2025/04/03 02:48:20 INFO  : A1: Making directory
2025/04/03 02:48:21 INFO  : A1/B1: Making directory
2025/04/03 02:48:21 INFO  : A1/B1/C1: Making directory
2025/04/03 02:48:23 DEBUG : removing 1 level 3 directories
2025/04/03 02:48:23 INFO  : A1/B1/C1: Removing directory
2025/04/03 02:48:23 DEBUG : removing 1 level 2 directories
2025/04/03 02:48:23 INFO  : A1/B1: Removing directory
--- PASS: TestRmdirsLeaveRoot (4.96s)
=== RUN   TestRemoveExisting
    run.go:180: Remote "OpenDrive root 'rclone-test-sajerek2homi'", Local "Local file system at /tmp/rclone306894911", Modify Window "1s"
2025/04/03 02:48:26 DEBUG : sub dir/test remove existing: Uploading chunk 0, size=11, remain=0
2025/04/03 02:48:28 DEBUG : sub dir/test remove existing with long name 123456789012345678901234567890123456789012345678901234567890123456789: Uploading chunk 0, size=21, remain=0
2025/04/03 02:48:31 DEBUG : sub dir/test remove existing: TEST: renaming existing object to "sub dir/test remove existing.xegesof2" before starting
2025/04/03 02:48:31 DEBUG : sub dir/test remove existing: same parent dir (ODFfODIwMTc4NF92dU5VUw) - using file/rename instead of move_copy for sub dir/test remove existing.xegesof2
2025/04/03 02:48:32 DEBUG : sub dir/test remove existing.xegesof2: TEST: removing renamed existing file after operation
2025/04/03 02:48:33 DEBUG : sub dir/test remove existing with long name 123456789012345678901234567890123456789012345678901234567890123456789: TEST: renaming existing object to "sub dir/test remove existing with long name 123456789012345678901234567890123456789012345678901234567890.degawot0" before starting
2025/04/03 02:48:33 DEBUG : sub dir/test remove existing with long name 123456789012345678901234567890123456789012345678901234567890123456789: same parent dir (ODFfODIwMTc4NF92dU5VUw) - using file/rename instead of move_copy for sub dir/test remove existing with long name 123456789012345678901234567890123456789012345678901234567890.degawot0
2025/04/03 02:48:34 DEBUG : sub dir/test remove existing with long name 123456789012345678901234567890123456789012345678901234567890.degawot0: TEST: renaming existing back after failed operation
2025/04/03 02:48:34 DEBUG : sub dir/test remove existing with long name 123456789012345678901234567890123456789012345678901234567890.degawot0: same parent dir (ODFfODIwMTc4NF92dU5VUw) - using file/rename instead of move_copy for sub dir/test remove existing with long name 123456789012345678901234567890123456789012345678901234567890123456789
2025/04/03 02:48:35 DEBUG : sub dir/test remove existing with long name 123456789012345678901234567890123456789012345678901234567890123456789: TEST: renaming existing object to "sub dir/test remove existing with long name 123456789012345678901234567890123456789012345678901234567890.diminuy3" before starting
2025/04/03 02:48:35 DEBUG : sub dir/test remove existing with long name 123456789012345678901234567890123456789012345678901234567890123456789: same parent dir (ODFfODIwMTc4NF92dU5VUw) - using file/rename instead of move_copy for sub dir/test remove existing with long name 123456789012345678901234567890123456789012345678901234567890.diminuy3
    operations_test.go:1952: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/fs/operations/operations_test.go:1952
        	Error:      	"       21 sub dir/test remove existing with long name 123456789012345678901234567890123456789012345678901234567890123456789\n" should not contain "       21 sub dir/test remove existing with long name 123456789012345678901234567890123456789012345678901234567890123456789\n"
        	Test:       	TestRemoveExisting
2025/04/03 02:48:35 DEBUG : sub dir/test remove existing with long name 123456789012345678901234567890123456789012345678901234567890.diminuy3: TEST: removing renamed existing file after operation
    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
--- FAIL: TestRemoveExisting (20.08s)
FAIL
2025/04/03 02:48:45 DEBUG : OpenDrive root 'rclone-test-sajerek2homi': Purge remote
"./operations.test -test.v -test.timeout 1h0m0s -remote TestOpenDrive: -verbose -test.run '^(TestCheckSizeOnly|TestPurge|TestRemoveExisting|TestRmdirsLeaveRoot)$'" - Finished ERROR in 57.636455444s (try 2/5): exit status 1: Failed [TestRemoveExisting]