"./sync.test -test.v -test.timeout 1h0m0s -remote TestLinkbox: -verbose -test.run '^(TestMoveOverSelf|TestServerSideCopyOverSelf|TestServerSideMoveOverSelf)$'" - Starting (try 4/5)
2026/08/08 05:21:36 DEBUG : Creating backend with remote "TestLinkbox:rclone-test-dixehes6zufa"
2026/08/08 05:21:36 DEBUG : Using config file from "/home/rclone/.rclone.conf"
2026/08/08 05:21:36 DEBUG : Linkbox root 'rclone-test-dixehes6zufa': Using cached web token
2026/08/08 05:21:37 DEBUG : Creating backend with remote "/tmp/rclone1786777151"
=== RUN   TestServerSideCopyOverSelf
    run.go:198: Remote "Linkbox root 'rclone-test-dixehes6zufa'", Local "Local file system at /tmp/rclone1786777151", Modify Window "876000h0m0s"
2026/08/08 05:21:42 DEBUG : sub dir/hello world: Trying to read object after upload: try again in 100ms (1/10)
2026/08/08 05:21:42 DEBUG : sub dir/hello world: Trying to read object after upload: try again in 200ms (2/10)
2026/08/08 05:21:43 DEBUG : sub dir/hello world: Trying to read object after upload: try again in 400ms (3/10)
2026/08/08 05:21:44 DEBUG : Creating backend with remote "TestLinkbox:rclone-test-nugekuy8weti"
2026/08/08 05:21:44 DEBUG : Linkbox root 'rclone-test-nugekuy8weti': Using cached web token
    sync_test.go:656: Server side copy (if possible) Linkbox root 'rclone-test-dixehes6zufa' -> Linkbox root 'rclone-test-nugekuy8weti'
2026/08/08 05:21:45 DEBUG : sub dir/hello world: Need to transfer - File not found at Destination
2026/08/08 05:21:45 DEBUG : Linkbox root 'rclone-test-nugekuy8weti': Waiting for checks to finish
2026/08/08 05:21:45 DEBUG : Linkbox root 'rclone-test-nugekuy8weti': Waiting for transfers to finish
2026/08/08 05:21:45 NOTICE: Time may be set wrong - time from "aht.nuplink3.net" is 1347h11m24.886947344s different from this computer
2026/08/08 05:21:51 DEBUG : sub dir/hello world: size = 11 OK
2026/08/08 05:21:51 INFO  : sub dir/hello world: Copied (new)
2026/08/08 05:21:51 DEBUG : sub dir/hello world: Update: removing old file
2026/08/08 05:21:54 DEBUG : sub dir/hello world: Trying to read object after upload: try again in 100ms (1/10)
2026/08/08 05:21:56 DEBUG : sub dir/hello world: size = 17 (Linkbox root 'rclone-test-dixehes6zufa')
2026/08/08 05:21:56 DEBUG : sub dir/hello world: size = 11 (Linkbox root 'rclone-test-nugekuy8weti')
2026/08/08 05:21:56 DEBUG : sub dir/hello world: Sizes differ
2026/08/08 05:21:56 DEBUG : Linkbox root 'rclone-test-nugekuy8weti': Waiting for checks to finish
2026/08/08 05:21:56 DEBUG : Linkbox root 'rclone-test-nugekuy8weti': Waiting for transfers to finish
2026/08/08 05:21:56 DEBUG : sub dir/hello world: Update: removing old file
2026/08/08 05:21:59 DEBUG : sub dir/hello world: size = 17 OK
2026/08/08 05:21:59 INFO  : sub dir/hello world: Copied (replaced existing)
2026/08/08 05:21:59 DEBUG : Linkbox root 'rclone-test-nugekuy8weti': Purge remote
--- PASS: TestServerSideCopyOverSelf (27.39s)
=== RUN   TestMoveOverSelf
    run.go:198: Remote "Linkbox root 'rclone-test-dixehes6zufa'", Local "Local file system at /tmp/rclone1786777151", Modify Window "876000h0m0s"
2026/08/08 05:22:09 DEBUG : Linkbox root 'rclone-test-dixehes6zufa': Waiting for checks to finish
2026/08/08 05:22:09 DEBUG : sub dir/hello world: size = 17 (Local file system at /tmp/rclone1786777151)
2026/08/08 05:22:09 DEBUG : sub dir/hello world: size = 11 (Linkbox root 'rclone-test-dixehes6zufa')
2026/08/08 05:22:09 DEBUG : sub dir/hello world: Sizes differ
2026/08/08 05:22:09 DEBUG : Linkbox root 'rclone-test-dixehes6zufa': Waiting for transfers to finish
2026/08/08 05:22:09 DEBUG : sub dir/hello world: Update: removing old file
2026/08/08 05:22:12 DEBUG : sub dir/hello world: size = 17 OK
2026/08/08 05:22:12 INFO  : sub dir/hello world: Copied (replaced existing)
2026/08/08 05:22:12 INFO  : sub dir/hello world: Deleted
    run.go:186: removing dir "sub dir" failed - try 1/3: sleeping 1s: directory not empty
--- PASS: TestMoveOverSelf (12.86s)
=== RUN   TestServerSideMoveOverSelf
    run.go:198: Remote "Linkbox root 'rclone-test-dixehes6zufa'", Local "Local file system at /tmp/rclone1786777151", Modify Window "876000h0m0s"
2026/08/08 05:22:21 DEBUG : Creating backend with remote "TestLinkbox:rclone-test-wicibaw4rufo"
2026/08/08 05:22:21 DEBUG : Linkbox root 'rclone-test-wicibaw4rufo': Using cached web token
    sync_test.go:701: Server side copy (if possible) Linkbox root 'rclone-test-dixehes6zufa' -> Linkbox root 'rclone-test-wicibaw4rufo'
2026/08/08 05:22:23 DEBUG : sub dir/hello world: Need to transfer - File not found at Destination
2026/08/08 05:22:23 DEBUG : Linkbox root 'rclone-test-wicibaw4rufo': Waiting for checks to finish
2026/08/08 05:22:23 DEBUG : Linkbox root 'rclone-test-wicibaw4rufo': Waiting for transfers to finish
2026/08/08 05:22:28 DEBUG : sub dir/hello world: size = 11 OK
2026/08/08 05:22:28 INFO  : sub dir/hello world: Copied (new)
2026/08/08 05:22:29 DEBUG : sub dir/hello world: Update: removing old file
2026/08/08 05:22:33 DEBUG : Linkbox root 'rclone-test-wicibaw4rufo': Waiting for checks to finish
2026/08/08 05:22:33 DEBUG : sub dir/hello world: size = 17 (Linkbox root 'rclone-test-dixehes6zufa')
2026/08/08 05:22:33 DEBUG : sub dir/hello world: size = 11 (Linkbox root 'rclone-test-wicibaw4rufo')
2026/08/08 05:22:33 DEBUG : sub dir/hello world: Sizes differ
2026/08/08 05:22:33 DEBUG : Linkbox root 'rclone-test-wicibaw4rufo': Waiting for transfers to finish
2026/08/08 05:22:33 DEBUG : sub dir/hello world: Update: removing old file
2026/08/08 05:22:36 DEBUG : sub dir/hello world: size = 17 OK
2026/08/08 05:22:36 INFO  : sub dir/hello world: Copied (replaced existing)
2026/08/08 05:22:37 INFO  : sub dir/hello world: Deleted
2026/08/08 05:22:40 DEBUG : sub dir/hello world: Trying to read object after upload: try again in 100ms (1/10)
2026/08/08 05:22:41 DEBUG : testing file moves
2026/08/08 05:22:41 DEBUG : sub dir/hello world: size = 24 (Linkbox root 'rclone-test-dixehes6zufa')
2026/08/08 05:22:41 DEBUG : sub dir/hello world: size = 17 (Linkbox root 'rclone-test-wicibaw4rufo')
2026/08/08 05:22:41 DEBUG : sub dir/hello world: Sizes differ
2026/08/08 05:22:41 DEBUG : Linkbox root 'rclone-test-wicibaw4rufo': Waiting for checks to finish
2026/08/08 05:22:41 DEBUG : Linkbox root 'rclone-test-wicibaw4rufo': Waiting for transfers to finish
2026/08/08 05:22:42 DEBUG : sub dir/hello world: Update: removing old file
2026/08/08 05:22:45 DEBUG : sub dir/hello world: Trying to read object after upload: try again in 100ms (1/10)
2026/08/08 05:22:45 DEBUG : sub dir/hello world: size = 24 OK
2026/08/08 05:22:45 INFO  : sub dir/hello world: Copied (replaced existing)
2026/08/08 05:22:46 INFO  : sub dir/hello world: Deleted
2026/08/08 05:22:47 DEBUG : Linkbox root 'rclone-test-wicibaw4rufo': Purge remote
--- PASS: TestServerSideMoveOverSelf (33.66s)
PASS
2026/08/08 05:22:51 DEBUG : Linkbox root 'rclone-test-dixehes6zufa': Purge remote
"./sync.test -test.v -test.timeout 1h0m0s -remote TestLinkbox: -verbose -test.run '^(TestMoveOverSelf|TestServerSideCopyOverSelf|TestServerSideMoveOverSelf)$'" - Finished OK in 1m16.361362267s (try 4/5)