"go test -v -timeout 1h0m0s -remote TestPikPak: -verbose -test.run '^TestIntegration$/^FsMkdir$/^FsPutFiles$/^FromRoot$/^Put$'" - Starting (try 4/5)
=== RUN   TestIntegration
    fstests.go:442: Using remote "TestPikPak:"
2025/01/12 03:47:21 DEBUG : Creating backend with remote "TestPikPak:rclone-test-reqibeb4jaju"
2025/01/12 03:47:21 DEBUG : Using config file from "/home/rclone/.rclone.conf"
=== RUN   TestIntegration/FsMkdir
=== RUN   TestIntegration/FsMkdir/FsPutFiles
2025/01/12 03:47:24 DEBUG : file name.txt: calculating gcid: failed to unwrap object from src: file name.txt
2025/01/12 03:47:24 DEBUG : file name.txt: gcid = 8c4b294b6ea0d266f149c38a6585a2fd74abf8ea
2025/01/12 03:47:27 DEBUG : pacer: low level retry 1/10 (error upload (upload) is still in PHASE_TYPE_PENDING)
2025/01/12 03:47:27 DEBUG : pacer: Rate limited, increasing sleep to 200ms
2025/01/12 03:47:27 DEBUG : pacer: low level retry 2/10 (error upload (upload) is still in PHASE_TYPE_PENDING)
2025/01/12 03:47:27 DEBUG : pacer: Rate limited, increasing sleep to 400ms
2025/01/12 03:47:27 DEBUG : pacer: low level retry 3/10 (error upload (upload) is still in PHASE_TYPE_PENDING)
2025/01/12 03:47:27 DEBUG : pacer: Rate limited, increasing sleep to 800ms
2025/01/12 03:47:28 DEBUG : pacer: low level retry 4/10 (error upload (upload) is still in PHASE_TYPE_PENDING)
2025/01/12 03:47:28 DEBUG : pacer: Rate limited, increasing sleep to 1.6s
2025/01/12 03:47:29 DEBUG : pacer: low level retry 5/10 (error upload (upload) is still in PHASE_TYPE_PENDING)
2025/01/12 03:47:29 DEBUG : pacer: Rate limited, increasing sleep to 2s
2025/01/12 03:47:30 DEBUG : pacer: Reducing sleep to 1.5s
2025/01/12 03:47:32 DEBUG : pacer: Reducing sleep to 1.125s
2025/01/12 03:47:34 DEBUG : pacer: Reducing sleep to 843.75ms
2025/01/12 03:47:35 DEBUG : pacer: Reducing sleep to 632.8125ms
2025/01/12 03:47:36 DEBUG : pacer: Reducing sleep to 474.609375ms
2025/01/12 03:47:36 DEBUG : pacer: Reducing sleep to 355.957031ms
2025/01/12 03:47:37 DEBUG : pacer: Reducing sleep to 266.967773ms
2025/01/12 03:47:37 DEBUG : pacer: Reducing sleep to 200.225829ms
2025/01/12 03:47:37 DEBUG : pacer: Reducing sleep to 150.169371ms
2025/01/12 03:47:38 DEBUG : pacer: Reducing sleep to 112.627028ms
2025/01/12 03:47:38 DEBUG : pacer: Reducing sleep to 100ms
2025/01/12 03:47:38 DEBUG : hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: calculating gcid: failed to unwrap object from src: hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt
2025/01/12 03:47:38 DEBUG : hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: gcid = 624844f5adad316c94c4aad2e1ef392b549e564d
2025/01/12 03:47:41 DEBUG : pacer: low level retry 1/10 (error upload (upload) is still in PHASE_TYPE_PENDING)
2025/01/12 03:47:41 DEBUG : pacer: Rate limited, increasing sleep to 200ms
2025/01/12 03:47:41 DEBUG : pacer: low level retry 2/10 (error upload (upload) is still in PHASE_TYPE_PENDING)
2025/01/12 03:47:41 DEBUG : pacer: Rate limited, increasing sleep to 400ms
2025/01/12 03:47:42 DEBUG : pacer: low level retry 3/10 (error upload (upload) is still in PHASE_TYPE_PENDING)
2025/01/12 03:47:42 DEBUG : pacer: Rate limited, increasing sleep to 800ms
2025/01/12 03:47:42 DEBUG : pacer: low level retry 4/10 (error upload (upload) is still in PHASE_TYPE_PENDING)
2025/01/12 03:47:42 DEBUG : pacer: Rate limited, increasing sleep to 1.6s
2025/01/12 03:47:43 DEBUG : pacer: Reducing sleep to 1.2s
2025/01/12 03:47:45 DEBUG : pacer: Reducing sleep to 900ms
2025/01/12 03:47:46 DEBUG : pacer: Reducing sleep to 675ms
2025/01/12 03:47:46 DEBUG : file name.txt: calculating gcid: failed to unwrap object from src: file name.txt
2025/01/12 03:47:46 DEBUG : file name.txt: gcid = ea7cf9d88821375dda57a0dda0f2214d1cfaf460
2025/01/12 03:47:47 DEBUG : pacer: Reducing sleep to 506.25ms
2025/01/12 03:47:49 DEBUG : pacer: Reducing sleep to 379.6875ms
2025/01/12 03:47:49 DEBUG : pacer: Reducing sleep to 284.765625ms
2025/01/12 03:47:50 DEBUG : pacer: Reducing sleep to 213.574218ms
2025/01/12 03:47:50 DEBUG : pacer: Reducing sleep to 160.180663ms
2025/01/12 03:47:50 DEBUG : pacer: Reducing sleep to 120.135497ms
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FromRoot
    fstests.go:1915: Opening root remote "TestPikPak:" path "rclone-test-reqibeb4jaju" from "TestPikPak:rclone-test-reqibeb4jaju"
2025/01/12 03:47:50 DEBUG : Creating backend with remote "TestPikPak:"
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FromRoot/Put
2025/01/12 03:47:52 DEBUG : rclone-test-reqibeb4jaju/created from root.txt: calculating gcid: failed to unwrap object from src: rclone-test-reqibeb4jaju/created from root.txt
2025/01/12 03:47:52 DEBUG : rclone-test-reqibeb4jaju/created from root.txt: gcid = e93619c7fc2d4a1704db51bd9c3cf5171afe7fd6
=== RUN   TestIntegration/FsMkdir/FsPutFiles/FromRoot/Put/Remove
2025/01/12 03:47:59 DEBUG : pacer: Reducing sleep to 100ms
2025/01/12 03:48:00 ERROR : : error listing: directory not found
--- PASS: TestIntegration (39.32s)
    --- PASS: TestIntegration/FsMkdir (36.55s)
        --- PASS: TestIntegration/FsMkdir/FsPutFiles (34.68s)
            --- PASS: TestIntegration/FsMkdir/FsPutFiles/FromRoot (8.26s)
                --- PASS: TestIntegration/FsMkdir/FsPutFiles/FromRoot/Put (8.26s)
                    --- PASS: TestIntegration/FsMkdir/FsPutFiles/FromRoot/Put/Remove (2.48s)
PASS
ok  	github.com/rclone/rclone/backend/pikpak	39.333s
"go test -v -timeout 1h0m0s -remote TestPikPak: -verbose -test.run '^TestIntegration$/^FsMkdir$/^FsPutFiles$/^FromRoot$/^Put$'" - Finished OK in 41.175497903s (try 4/5)