"./sync.test -test.v -test.timeout 1h0m0s -remote TestOpenDrive: -verbose -test.run '^(TestFixCase|TestServerSideCopyOverSelf)$'" - Starting (try 2/5)
2025/03/10 06:28:55 DEBUG : Creating backend with remote "TestOpenDrive:rclone-test-zewiqay4suba"
2025/03/10 06:28:55 DEBUG : Using config file from "/home/rclone/.rclone.conf"
2025/03/10 06:28:56 DEBUG : Starting OpenDrive session with ID: f00c304e58c06ffb8fa491f3bffba13f55f676c20b68ed1aa807d57001d399cd
2025/03/10 06:28:56 DEBUG : Creating backend with remote "/tmp/rclone234414106"
=== RUN   TestServerSideCopyOverSelf
    run.go:180: Remote "OpenDrive root 'rclone-test-zewiqay4suba'", Local "Local file system at /tmp/rclone234414106", Modify Window "1s"
2025/03/10 06:28:57 DEBUG : sub dir/hello world: Uploading chunk 0, size=11, remain=0
2025/03/10 06:28:59 DEBUG : Creating backend with remote "TestOpenDrive:rclone-test-dajobib1kaco"
2025/03/10 06:28:59 DEBUG : Starting OpenDrive session with ID: 34c09a86602c3db3a5d0ea5a0908187f26805672ad8b4a64e8b66bbf8c1947a2
    sync_test.go:626: Server side copy (if possible) OpenDrive root 'rclone-test-zewiqay4suba' -> OpenDrive root 'rclone-test-dajobib1kaco'
2025/03/10 06:29:00 DEBUG : sub dir/hello world: Need to transfer - File not found at Destination
2025/03/10 06:29:00 DEBUG : OpenDrive root 'rclone-test-dajobib1kaco': Waiting for checks to finish
2025/03/10 06:29:00 DEBUG : OpenDrive root 'rclone-test-dajobib1kaco': Waiting for transfers to finish
2025/03/10 06:29:01 DEBUG : sub dir/hello world: Dst hash empty - aborting Src hash check
2025/03/10 06:29:01 INFO  : sub dir/hello world: Copied (server-side copy)
    run.go:180: Remote "OpenDrive root 'rclone-test-zewiqay4suba'", Local "Local file system at /tmp/rclone234414106", Modify Window "1s"
2025/03/10 06:29:01 DEBUG : sub dir/hello world: Uploading chunk 0, size=17, remain=0
2025/03/10 06:29:03 DEBUG : sub dir/hello world: Sizes differ (src 17 vs dst 11)
2025/03/10 06:29:03 DEBUG : OpenDrive root 'rclone-test-dajobib1kaco': Waiting for checks to finish
2025/03/10 06:29:03 DEBUG : OpenDrive root 'rclone-test-dajobib1kaco': Waiting for transfers to finish
2025/03/10 06:29:04 DEBUG : sub dir/hello world: Dst hash empty - aborting Src hash check
2025/03/10 06:29:04 INFO  : sub dir/hello world: Copied (server-side copy)
    run.go:180: Remote "OpenDrive root 'rclone-test-zewiqay4suba'", Local "Local file system at /tmp/rclone234414106", Modify Window "1s"
2025/03/10 06:29:04 DEBUG : OpenDrive root 'rclone-test-dajobib1kaco': Purge remote
--- PASS: TestServerSideCopyOverSelf (10.10s)
=== RUN   TestFixCase
    run.go:180: Remote "OpenDrive root 'rclone-test-zewiqay4suba'", Local "Local file system at /tmp/rclone234414106", Modify Window "1s"
2025/03/10 06:29:07 DEBUG : EXISTING: Uploading chunk 0, size=6, remain=0
2025/03/10 06:29:08 DEBUG : EXISTINGBUTDIFFERENT: Uploading chunk 0, size=8, remain=0
2025/03/10 06:29:11 DEBUG : SUBDIRA/subdirb/SUBDIRC/HELLO: Uploading chunk 0, size=8, remain=0
2025/03/10 06:29:14 DEBUG : SUBDIRA/subdirb/SUBDIRC/subdird/filewithoutcasedifferences: Uploading chunk 0, size=8, remain=0
2025/03/10 06:29:15 DEBUG : existing: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2025/03/10 06:29:15 DEBUG : existing: Unchanged skipping
2025/03/10 06:29:15 DEBUG : existingbutdifferent: Sizes differ (src 5 vs dst 8)
2025/03/10 06:29:16 DEBUG : subdira-rclone-move-buviruw0: same parent dir (ODFfODEyMDg1NV90Mmk2Qg) - using folder/rename instead of move_copy
2025/03/10 06:29:16 DEBUG : EXISTING: moving to existing-rclone-move-yivusev6
2025/03/10 06:29:16 DEBUG : EXISTINGBUTDIFFERENT: moving to existingbutdifferent-rclone-move-pulavar4
2025/03/10 06:29:16 DEBUG : subdira: same parent dir (ODFfODEyMDg1NV90Mmk2Qg) - using folder/rename instead of move_copy
2025/03/10 06:29:16 DEBUG : EXISTINGBUTDIFFERENT: same parent dir (ODFfODEyMDg1NV90Mmk2Qg) - using file/rename instead of move_copy for existingbutdifferent-rclone-move-pulavar4
2025/03/10 06:29:16 DEBUG : EXISTING: same parent dir (ODFfODEyMDg1NV90Mmk2Qg) - using file/rename instead of move_copy for existing-rclone-move-yivusev6
2025/03/10 06:29:16 INFO  : SUBDIRA: Fixed case by renaming to: subdira
2025/03/10 06:29:17 INFO  : EXISTINGBUTDIFFERENT: Moved (server-side) to: existingbutdifferent-rclone-move-pulavar4
2025/03/10 06:29:17 DEBUG : EXISTINGBUTDIFFERENT: moving to existingbutdifferent
2025/03/10 06:29:17 INFO  : EXISTING: Moved (server-side) to: existing-rclone-move-yivusev6
2025/03/10 06:29:17 DEBUG : EXISTING: moving to existing
2025/03/10 06:29:17 DEBUG : existing-rclone-move-yivusev6: same parent dir (ODFfODEyMDg1NV90Mmk2Qg) - using file/rename instead of move_copy for existing
2025/03/10 06:29:17 DEBUG : subdira/subdirb-rclone-move-herawip6: same parent dir (ODFfODEyMDg1OV9jeDgxNg) - using folder/rename instead of move_copy
2025/03/10 06:29:17 DEBUG : existingbutdifferent-rclone-move-pulavar4: same parent dir (ODFfODEyMDg1NV90Mmk2Qg) - using file/rename instead of move_copy for existingbutdifferent
2025/03/10 06:29:17 INFO  : existing-rclone-move-yivusev6: Moved (server-side) to: existing
2025/03/10 06:29:17 INFO  : EXISTING: Moved (server-side) to: existing
2025/03/10 06:29:17 INFO  : EXISTING: Fixed case by renaming to: existing
2025/03/10 06:29:17 INFO  : existingbutdifferent-rclone-move-pulavar4: Moved (server-side) to: existingbutdifferent
2025/03/10 06:29:17 INFO  : EXISTINGBUTDIFFERENT: Moved (server-side) to: existingbutdifferent
2025/03/10 06:29:17 INFO  : EXISTINGBUTDIFFERENT: Fixed case by renaming to: existingbutdifferent
2025/03/10 06:29:18 DEBUG : existingbutdifferent: Uploading chunk 0, size=5, remain=0
2025/03/10 06:29:18 DEBUG : subdira/subdirb: same parent dir (ODFfODEyMDg1OV9jeDgxNg) - using folder/rename instead of move_copy
2025/03/10 06:29:18 INFO  : SUBDIRA/subdirb: Fixed case by renaming to: subdira/subdirb
2025/03/10 06:29:19 DEBUG : subdira/subdirb/subdirc-rclone-move-kunodew1: same parent dir (ODFfODEyMDg2MF9wMjZUTQ) - using folder/rename instead of move_copy
2025/03/10 06:29:19 DEBUG : existingbutdifferent: md5 = 81bdd90fd4bc5a1c9b7b603014ff1388 OK
2025/03/10 06:29:19 INFO  : existingbutdifferent: Copied (replaced existing)
2025/03/10 06:29:19 DEBUG : subdira/subdirb/subdirc: same parent dir (ODFfODEyMDg2MF9wMjZUTQ) - using folder/rename instead of move_copy
2025/03/10 06:29:19 INFO  : SUBDIRA/subdirb/SUBDIRC: Fixed case by renaming to: subdira/subdirb/subdirc
2025/03/10 06:29:20 DEBUG : subdira/subdirb/subdirc/hello: Sizes differ (src 5 vs dst 8)
2025/03/10 06:29:20 DEBUG : subdira/subdirb/subdirc/subdird-rclone-move-yalebos8: same parent dir (ODFfODEyMDg2MV9VcmlsMg) - using folder/rename instead of move_copy
2025/03/10 06:29:20 DEBUG : SUBDIRA/subdirb/SUBDIRC/HELLO: moving to subdira/subdirb/subdirc/hello-rclone-move-mataxez6
2025/03/10 06:29:20 DEBUG : SUBDIRA/subdirb/SUBDIRC/HELLO: same parent dir (ODFfODEyMDg2MV9VcmlsMg) - using file/rename instead of move_copy for subdira/subdirb/subdirc/hello-rclone-move-mataxez6
2025/03/10 06:29:20 DEBUG : subdira/subdirb/subdirc/subdird: same parent dir (ODFfODEyMDg2MV9VcmlsMg) - using folder/rename instead of move_copy
2025/03/10 06:29:21 INFO  : SUBDIRA/subdirb/SUBDIRC/subdird: Fixed case by renaming to: subdira/subdirb/subdirc/subdird
2025/03/10 06:29:21 DEBUG : subdira/subdirb/subdirc/subdird/filewithoutcasedifferences: Sizes differ (src 5 vs dst 8)
2025/03/10 06:29:21 DEBUG : OpenDrive root 'rclone-test-zewiqay4suba': Waiting for checks to finish
2025/03/10 06:29:21 DEBUG : SUBDIRA/subdirb/SUBDIRC/subdird/filewithoutcasedifferences: moving to subdira/subdirb/subdirc/subdird/filewithoutcasedifferences-rclone-move-vajepiw6
2025/03/10 06:29:21 INFO  : SUBDIRA/subdirb/SUBDIRC/HELLO: Moved (server-side) to: subdira/subdirb/subdirc/hello-rclone-move-mataxez6
2025/03/10 06:29:21 DEBUG : SUBDIRA/subdirb/SUBDIRC/HELLO: moving to subdira/subdirb/subdirc/hello
2025/03/10 06:29:21 DEBUG : SUBDIRA/subdirb/SUBDIRC/subdird/filewithoutcasedifferences: same parent dir (ODFfODEyMDg2NV9uaFFtQQ) - using file/rename instead of move_copy for subdira/subdirb/subdirc/subdird/filewithoutcasedifferences-rclone-move-vajepiw6
2025/03/10 06:29:21 DEBUG : subdira/subdirb/subdirc/hello-rclone-move-mataxez6: same parent dir (ODFfODEyMDg2MV9VcmlsMg) - using file/rename instead of move_copy for subdira/subdirb/subdirc/hello
2025/03/10 06:29:22 INFO  : SUBDIRA/subdirb/SUBDIRC/subdird/filewithoutcasedifferences: Moved (server-side) to: subdira/subdirb/subdirc/subdird/filewithoutcasedifferences-rclone-move-vajepiw6
2025/03/10 06:29:22 DEBUG : SUBDIRA/subdirb/SUBDIRC/subdird/filewithoutcasedifferences: moving to subdira/subdirb/subdirc/subdird/filewithoutcasedifferences
2025/03/10 06:29:22 INFO  : subdira/subdirb/subdirc/hello-rclone-move-mataxez6: Moved (server-side) to: subdira/subdirb/subdirc/hello
2025/03/10 06:29:22 INFO  : SUBDIRA/subdirb/SUBDIRC/HELLO: Moved (server-side) to: subdira/subdirb/subdirc/hello
2025/03/10 06:29:22 INFO  : SUBDIRA/subdirb/SUBDIRC/HELLO: Fixed case by renaming to: subdira/subdirb/subdirc/hello
2025/03/10 06:29:22 DEBUG : subdira/subdirb/subdirc/subdird/filewithoutcasedifferences-rclone-move-vajepiw6: same parent dir (ODFfODEyMDg2NV9uaFFtQQ) - using file/rename instead of move_copy for subdira/subdirb/subdirc/subdird/filewithoutcasedifferences
2025/03/10 06:29:22 INFO  : subdira/subdirb/subdirc/subdird/filewithoutcasedifferences-rclone-move-vajepiw6: Moved (server-side) to: subdira/subdirb/subdirc/subdird/filewithoutcasedifferences
2025/03/10 06:29:22 INFO  : SUBDIRA/subdirb/SUBDIRC/subdird/filewithoutcasedifferences: Moved (server-side) to: subdira/subdirb/subdirc/subdird/filewithoutcasedifferences
2025/03/10 06:29:22 INFO  : SUBDIRA/subdirb/SUBDIRC/subdird/filewithoutcasedifferences: Fixed case by renaming to: subdira/subdirb/subdirc/subdird/filewithoutcasedifferences
2025/03/10 06:29:22 DEBUG : OpenDrive root 'rclone-test-zewiqay4suba': Waiting for transfers to finish
2025/03/10 06:29:22 DEBUG : subdira/subdirb/subdirc/hello: Uploading chunk 0, size=5, remain=0
2025/03/10 06:29:22 DEBUG : subdira/subdirb/subdirc/subdird/filewithoutcasedifferences: Uploading chunk 0, size=5, remain=0
2025/03/10 06:29:23 DEBUG : subdira/subdirb/subdirc/hello: md5 = 81bdd90fd4bc5a1c9b7b603014ff1388 OK
2025/03/10 06:29:23 INFO  : subdira/subdirb/subdirc/hello: Copied (replaced existing)
2025/03/10 06:29:23 DEBUG : subdira/subdirb/subdirc/subdird/filewithoutcasedifferences: md5 = 81bdd90fd4bc5a1c9b7b603014ff1388 OK
2025/03/10 06:29:23 INFO  : subdira/subdirb/subdirc/subdird/filewithoutcasedifferences: Copied (replaced existing)
2025/03/10 06:29:23 DEBUG : Waiting for deletions to finish
--- PASS: TestFixCase (21.23s)
PASS
2025/03/10 06:29:27 DEBUG : OpenDrive root 'rclone-test-zewiqay4suba': Purge remote
"./sync.test -test.v -test.timeout 1h0m0s -remote TestOpenDrive: -verbose -test.run '^(TestFixCase|TestServerSideCopyOverSelf)$'" - Finished OK in 32.52757197s (try 2/5)