"./sync.test -test.v -test.timeout 1h0m0s -remote TestShade: -verbose -test.run '^TestSyncCompareDest$'" - Starting (try 2/5)
2025/12/17 03:32:23 DEBUG : Creating backend with remote "TestShade:rclone-test-bizalel3qaqi"
2025/12/17 03:32:23 DEBUG : Using config file from "/home/rclone/.rclone.conf"
2025/12/17 03:32:23 DEBUG : Creating new ShadeFS backend with drive: cf193d00-c783-4bab-aa7a-fd84b3700d27
2025/12/17 03:32:23 DEBUG : Creating backend with remote "/tmp/rclone3373169095"
=== RUN   TestSyncCompareDest
    run.go:185: Remote "Shade drive cf193d00-c783-4bab-aa7a-fd84b3700d27 path rclone-test-bizalel3qaqi", Local "Local file system at /tmp/rclone3373169095", Modify Window "876000h0m0s"
2025/12/17 03:32:23 DEBUG : Creating backend with remote "TestShade:rclone-test-bizalel3qaqi/dst"
2025/12/17 03:32:23 DEBUG : Creating new ShadeFS backend with drive: cf193d00-c783-4bab-aa7a-fd84b3700d27
2025/12/17 03:32:23 DEBUG : Creating backend with remote "TestShade:rclone-test-bizalel3qaqi/CompareDest"
2025/12/17 03:32:23 DEBUG : Creating new ShadeFS backend with drive: cf193d00-c783-4bab-aa7a-fd84b3700d27
2025/12/17 03:32:23 DEBUG : Shade drive cf193d00-c783-4bab-aa7a-fd84b3700d27 path rclone-test-bizalel3qaqi/dst: Error from List call: HTTP error 404 (404 Not Found) returned body: "can't derive ino for path"
2025/12/17 03:32:24 DEBUG : one: Need to transfer - File not found at Destination
2025/12/17 03:32:24 DEBUG : Shade drive cf193d00-c783-4bab-aa7a-fd84b3700d27 path rclone-test-bizalel3qaqi/dst: Waiting for checks to finish
2025/12/17 03:32:24 DEBUG : Shade drive cf193d00-c783-4bab-aa7a-fd84b3700d27 path rclone-test-bizalel3qaqi/dst: Waiting for transfers to finish
2025/12/17 03:32:24 DEBUG : one: multipart upload: starting chunk 0 size 3 offset 0/3
2025/12/17 03:32:26 DEBUG : one: size = 3 OK
2025/12/17 03:32:26 INFO  : one: Copied (new)
2025/12/17 03:32:26 DEBUG : Waiting for deletions to finish
2025/12/17 03:32:26 DEBUG : one: size = 5 (Local file system at /tmp/rclone3373169095)
2025/12/17 03:32:26 DEBUG : one: size = 3 (Shade drive cf193d00-c783-4bab-aa7a-fd84b3700d27 path rclone-test-bizalel3qaqi/dst)
2025/12/17 03:32:26 DEBUG : one: Sizes differ
2025/12/17 03:32:26 DEBUG : Shade drive cf193d00-c783-4bab-aa7a-fd84b3700d27 path rclone-test-bizalel3qaqi/dst: Waiting for checks to finish
2025/12/17 03:32:26 DEBUG : Shade drive cf193d00-c783-4bab-aa7a-fd84b3700d27 path rclone-test-bizalel3qaqi/dst: Waiting for transfers to finish
2025/12/17 03:32:27 DEBUG : one: multipart upload: starting chunk 0 size 5 offset 0/5
2025/12/17 03:32:28 DEBUG : one: size = 5 OK
2025/12/17 03:32:28 INFO  : one: Copied (replaced existing)
2025/12/17 03:32:28 DEBUG : Waiting for deletions to finish
2025/12/17 03:32:29 DEBUG : dst/one: multipart upload: starting chunk 0 size 3 offset 0/3
2025/12/17 03:32:31 DEBUG : CompareDest/one: multipart upload: starting chunk 0 size 5 offset 0/5
2025/12/17 03:32:33 DEBUG : one: size = 5 (Local file system at /tmp/rclone3373169095)
2025/12/17 03:32:33 DEBUG : one: size = 3 (Shade drive cf193d00-c783-4bab-aa7a-fd84b3700d27 path rclone-test-bizalel3qaqi/dst)
2025/12/17 03:32:33 DEBUG : one: Sizes differ
2025/12/17 03:32:33 DEBUG : Shade drive cf193d00-c783-4bab-aa7a-fd84b3700d27 path rclone-test-bizalel3qaqi/dst: Waiting for checks to finish
2025/12/17 03:32:33 DEBUG : one: size = 5 OK
2025/12/17 03:32:33 DEBUG : one: Sizes identical
2025/12/17 03:32:33 DEBUG : one: Destination found in --compare-dest, skipping
2025/12/17 03:32:33 DEBUG : Shade drive cf193d00-c783-4bab-aa7a-fd84b3700d27 path rclone-test-bizalel3qaqi/dst: Waiting for transfers to finish
2025/12/17 03:32:33 DEBUG : Waiting for deletions to finish
2025/12/17 03:32:33 INFO  : There was nothing to transfer
2025/12/17 03:32:34 DEBUG : CompareDest/two: multipart upload: starting chunk 0 size 3 offset 0/3
2025/12/17 03:32:36 DEBUG : one: size = 5 (Local file system at /tmp/rclone3373169095)
2025/12/17 03:32:36 DEBUG : one: size = 3 (Shade drive cf193d00-c783-4bab-aa7a-fd84b3700d27 path rclone-test-bizalel3qaqi/dst)
2025/12/17 03:32:36 DEBUG : one: Sizes differ
2025/12/17 03:32:36 DEBUG : two: size = 3 OK
2025/12/17 03:32:36 DEBUG : two: Sizes identical
2025/12/17 03:32:36 DEBUG : two: Destination found in --compare-dest, skipping
2025/12/17 03:32:36 DEBUG : Shade drive cf193d00-c783-4bab-aa7a-fd84b3700d27 path rclone-test-bizalel3qaqi/dst: Waiting for checks to finish
2025/12/17 03:32:36 DEBUG : one: size = 5 OK
2025/12/17 03:32:36 DEBUG : one: Sizes identical
2025/12/17 03:32:36 DEBUG : one: Destination found in --compare-dest, skipping
2025/12/17 03:32:36 DEBUG : Shade drive cf193d00-c783-4bab-aa7a-fd84b3700d27 path rclone-test-bizalel3qaqi/dst: Waiting for transfers to finish
2025/12/17 03:32:36 DEBUG : Waiting for deletions to finish
2025/12/17 03:32:36 INFO  : There was nothing to transfer
2025/12/17 03:32:37 DEBUG : one: size = 5 (Local file system at /tmp/rclone3373169095)
2025/12/17 03:32:37 DEBUG : one: size = 3 (Shade drive cf193d00-c783-4bab-aa7a-fd84b3700d27 path rclone-test-bizalel3qaqi/dst)
2025/12/17 03:32:37 DEBUG : one: Sizes differ
2025/12/17 03:32:37 DEBUG : two: size = 3 OK
2025/12/17 03:32:37 DEBUG : two: Sizes identical
2025/12/17 03:32:37 DEBUG : two: Destination found in --compare-dest, skipping
2025/12/17 03:32:37 DEBUG : Shade drive cf193d00-c783-4bab-aa7a-fd84b3700d27 path rclone-test-bizalel3qaqi/dst: Waiting for checks to finish
2025/12/17 03:32:37 DEBUG : one: size = 5 OK
2025/12/17 03:32:37 DEBUG : one: Sizes identical
2025/12/17 03:32:37 DEBUG : one: Destination found in --compare-dest, skipping
2025/12/17 03:32:37 DEBUG : Shade drive cf193d00-c783-4bab-aa7a-fd84b3700d27 path rclone-test-bizalel3qaqi/dst: Waiting for transfers to finish
2025/12/17 03:32:37 DEBUG : Waiting for deletions to finish
2025/12/17 03:32:37 INFO  : There was nothing to transfer
    sync_test.go:2206: No hash on uploaded file so skipping compare timestamp test
2025/12/17 03:32:37 DEBUG : one: size = 5 (Local file system at /tmp/rclone3373169095)
2025/12/17 03:32:37 DEBUG : one: size = 3 (Shade drive cf193d00-c783-4bab-aa7a-fd84b3700d27 path rclone-test-bizalel3qaqi/dst)
2025/12/17 03:32:37 DEBUG : one: Sizes differ
2025/12/17 03:32:38 DEBUG : two: size = 5 (Local file system at /tmp/rclone3373169095)
2025/12/17 03:32:38 DEBUG : two: size = 3 (Shade drive cf193d00-c783-4bab-aa7a-fd84b3700d27 path rclone-test-bizalel3qaqi/CompareDest)
2025/12/17 03:32:38 DEBUG : two: Sizes differ
2025/12/17 03:32:38 DEBUG : two: Need to transfer - File not found at Destination
2025/12/17 03:32:38 DEBUG : Shade drive cf193d00-c783-4bab-aa7a-fd84b3700d27 path rclone-test-bizalel3qaqi/dst: Waiting for checks to finish
2025/12/17 03:32:38 DEBUG : one: size = 5 OK
2025/12/17 03:32:38 DEBUG : one: Sizes identical
2025/12/17 03:32:38 DEBUG : one: Destination found in --compare-dest, skipping
2025/12/17 03:32:38 DEBUG : Shade drive cf193d00-c783-4bab-aa7a-fd84b3700d27 path rclone-test-bizalel3qaqi/dst: Waiting for transfers to finish
2025/12/17 03:32:38 DEBUG : two: multipart upload: starting chunk 0 size 5 offset 0/5
2025/12/17 03:32:39 DEBUG : two: size = 5 OK
2025/12/17 03:32:39 INFO  : two: Copied (new)
2025/12/17 03:32:39 DEBUG : Waiting for deletions to finish
--- PASS: TestSyncCompareDest (18.13s)
PASS
2025/12/17 03:32:41 DEBUG : Shade drive cf193d00-c783-4bab-aa7a-fd84b3700d27 path rclone-test-bizalel3qaqi: Purge dir ""
"./sync.test -test.v -test.timeout 1h0m0s -remote TestShade: -verbose -test.run '^TestSyncCompareDest$'" - Finished OK in 18.802577573s (try 2/5)