"go test -v -timeout 1h0m0s -remote TestPikPak: -verbose -test.run '^TestIntegration$/^FsMkdir$/^FsPutFiles$/^(FsDirMove|FsPurge|FsPurgeRoot)$|^TestIntegration$/^FsMkdir$/^FsPutFiles$/^FromRoot$/^(List|ListEntries)$'" - Starting (try 4/5) === RUN TestIntegration fstests.go:442: Using remote "TestPikPak:" 2024/12/19 02:48:37 DEBUG : Creating backend with remote "TestPikPak:rclone-test-lekenat2veze" 2024/12/19 02:48:37 DEBUG : Using config file from "/home/rclone/.rclone.conf" === RUN TestIntegration/FsMkdir === RUN TestIntegration/FsMkdir/FsPutFiles 2024/12/19 02:48:40 DEBUG : file name.txt: calculating gcid: failed to unwrap object from src: file name.txt 2024/12/19 02:48:40 DEBUG : file name.txt: gcid = ab26060ed42abe194985d698fc6540fbe473f9c4 2024/12/19 02:48:45 DEBUG : hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: calculating gcid: failed to unwrap object from src: hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt 2024/12/19 02:48:45 DEBUG : hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: gcid = 4f4b8972e2103fab37b566ba48b9f02a78d53a10 2024/12/19 02:48:47 DEBUG : pacer: low level retry 1/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2024/12/19 02:48:47 DEBUG : pacer: Rate limited, increasing sleep to 200ms 2024/12/19 02:48:48 DEBUG : pacer: low level retry 2/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2024/12/19 02:48:48 DEBUG : pacer: Rate limited, increasing sleep to 400ms 2024/12/19 02:48:48 DEBUG : pacer: low level retry 3/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2024/12/19 02:48:48 DEBUG : pacer: Rate limited, increasing sleep to 800ms 2024/12/19 02:48:48 DEBUG : pacer: low level retry 4/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2024/12/19 02:48:48 DEBUG : pacer: Rate limited, increasing sleep to 1.6s 2024/12/19 02:48:49 DEBUG : pacer: low level retry 5/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2024/12/19 02:48:49 DEBUG : pacer: Rate limited, increasing sleep to 2s 2024/12/19 02:48:51 DEBUG : pacer: Reducing sleep to 1.5s 2024/12/19 02:48:53 DEBUG : pacer: Reducing sleep to 1.125s 2024/12/19 02:48:54 DEBUG : pacer: Reducing sleep to 843.75ms 2024/12/19 02:48:54 DEBUG : file name.txt: calculating gcid: failed to unwrap object from src: file name.txt 2024/12/19 02:48:54 DEBUG : file name.txt: gcid = cf2d0d577102f5edc666dc9fb12fe274e7c67061 2024/12/19 02:48:55 DEBUG : pacer: Reducing sleep to 632.8125ms 2024/12/19 02:48:57 DEBUG : pacer: low level retry 1/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2024/12/19 02:48:57 DEBUG : pacer: Rate limited, increasing sleep to 1.265625s 2024/12/19 02:48:58 DEBUG : pacer: low level retry 2/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2024/12/19 02:48:58 DEBUG : pacer: Rate limited, increasing sleep to 2s 2024/12/19 02:48:59 DEBUG : pacer: low level retry 3/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2024/12/19 02:49:01 DEBUG : pacer: low level retry 4/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2024/12/19 02:49:03 DEBUG : pacer: low level retry 5/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2024/12/19 02:49:05 DEBUG : pacer: low level retry 6/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2024/12/19 02:49:07 DEBUG : pacer: low level retry 7/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2024/12/19 02:49:09 DEBUG : pacer: low level retry 8/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2024/12/19 02:49:11 DEBUG : pacer: Reducing sleep to 1.5s 2024/12/19 02:49:13 DEBUG : pacer: Reducing sleep to 1.125s 2024/12/19 02:49:15 DEBUG : pacer: Reducing sleep to 843.75ms 2024/12/19 02:49:16 DEBUG : pacer: Reducing sleep to 632.8125ms 2024/12/19 02:49:17 DEBUG : pacer: Reducing sleep to 474.609375ms === RUN TestIntegration/FsMkdir/FsPutFiles/FsPurge 2024/12/19 02:49:17 DEBUG : pacer: Reducing sleep to 355.957031ms 2024/12/19 02:49:18 DEBUG : pacer: Reducing sleep to 266.967773ms 2024/12/19 02:49:18 DEBUG : pacer: Reducing sleep to 200.225829ms 2024/12/19 02:49:18 DEBUG : dirToPurge/fileToPurge.txt: calculating gcid: failed to unwrap object from src: dirToPurge/fileToPurge.txt 2024/12/19 02:49:18 DEBUG : dirToPurge/fileToPurge.txt: gcid = bec5dfa34638ee8a6018a4cb37ff3de52f55c976 2024/12/19 02:49:19 DEBUG : pacer: Reducing sleep to 150.169371ms 2024/12/19 02:49:20 DEBUG : pacer: low level retry 1/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2024/12/19 02:49:20 DEBUG : pacer: Rate limited, increasing sleep to 300.338742ms 2024/12/19 02:49:21 DEBUG : pacer: low level retry 2/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2024/12/19 02:49:21 DEBUG : pacer: Rate limited, increasing sleep to 600.677484ms 2024/12/19 02:49:21 DEBUG : pacer: low level retry 3/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2024/12/19 02:49:21 DEBUG : pacer: Rate limited, increasing sleep to 1.201354968s 2024/12/19 02:49:22 DEBUG : pacer: Reducing sleep to 901.016226ms 2024/12/19 02:49:23 DEBUG : pacer: Reducing sleep to 675.762169ms 2024/12/19 02:49:24 DEBUG : pacer: Reducing sleep to 506.821626ms 2024/12/19 02:49:24 DEBUG : pacer: Reducing sleep to 380.116219ms 2024/12/19 02:49:25 DEBUG : pacer: Reducing sleep to 285.087164ms 2024/12/19 02:49:25 DEBUG : pacer: Reducing sleep to 213.815373ms 2024/12/19 02:49:26 DEBUG : pacer: Reducing sleep to 160.361529ms 2024/12/19 02:49:26 DEBUG : pacer: Reducing sleep to 120.271146ms 2024/12/19 02:49:26 DEBUG : pacer: Reducing sleep to 100ms === RUN TestIntegration/FsMkdir/FsPutFiles/FsPurgeRoot 2024/12/19 02:49:29 DEBUG : dirToPurgeFromRoot/fileToPurgeFromRoot.txt: calculating gcid: failed to unwrap object from src: dirToPurgeFromRoot/fileToPurgeFromRoot.txt 2024/12/19 02:49:29 DEBUG : dirToPurgeFromRoot/fileToPurgeFromRoot.txt: gcid = 8a84a3fdbaadfb49756e06be12af1c924c1df640 2024/12/19 02:49:33 DEBUG : Creating backend with remote "TestPikPak:rclone-test-lekenat2veze/dirToPurgeFromRoot" 2024/12/19 02:49:33 DEBUG : Config file has changed externally - reloading === RUN TestIntegration/FsMkdir/FsPutFiles/FsDirMove 2024/12/19 02:49:36 DEBUG : Creating backend with remote "TestPikPak:rclone-test-lusefaq2yaxo" 2024/12/19 02:49:46 DEBUG : PikPak root 'rclone-test-lusefaq2yaxo': Purge remote === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot fstests.go:1915: Opening root remote "TestPikPak:" path "rclone-test-lekenat2veze" from "TestPikPak:rclone-test-lekenat2veze" 2024/12/19 02:49:47 DEBUG : Creating backend with remote "TestPikPak:" === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot/List === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot/ListEntries 2024/12/19 02:49:50 ERROR : : error listing: directory not found --- PASS: TestIntegration (73.28s) --- PASS: TestIntegration/FsMkdir (71.10s) --- PASS: TestIntegration/FsMkdir/FsPutFiles (69.43s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsPurge (11.34s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsPurgeRoot (8.24s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsDirMove (10.46s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FromRoot (2.36s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FromRoot/List (2.11s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FromRoot/ListEntries (0.25s) PASS ok github.com/rclone/rclone/backend/pikpak 73.302s "go test -v -timeout 1h0m0s -remote TestPikPak: -verbose -test.run '^TestIntegration$/^FsMkdir$/^FsPutFiles$/^(FsDirMove|FsPurge|FsPurgeRoot)$|^TestIntegration$/^FsMkdir$/^FsPutFiles$/^FromRoot$/^(List|ListEntries)$'" - Finished OK in 1m14.170364386s (try 4/5)