"go test -v -timeout 2h0m0s -remote TestZoho: -verbose" - Starting (try 1/5) === RUN TestFolderListLimiter --- PASS: TestFolderListLimiter (0.00s) === RUN TestFolderWindowLimiterShape --- PASS: TestFolderWindowLimiterShape (0.00s) === RUN TestFolderWindowLimiterIdleResume --- PASS: TestFolderWindowLimiterIdleResume (0.00s) === RUN TestFolderWindowLimiterClamps --- PASS: TestFolderWindowLimiterClamps (0.00s) === RUN TestFolderListLimiterConcurrent --- PASS: TestFolderListLimiterConcurrent (0.00s) === RUN TestTPSMinSleep --- PASS: TestTPSMinSleep (0.00s) === RUN TestShouldRetry === RUN TestShouldRetry/429_honours_Retry-After 2026/07/07 02:28:48 NOTICE: zoho root '': Too many requests: Trying again in 6 seconds. assert.AnError general error for testing === RUN TestShouldRetry/429_without_Retry-After_falls_back_to_60s 2026/07/07 02:28:48 NOTICE: zoho root '': Too many requests: Trying again in 61 seconds. assert.AnError general error for testing === RUN TestShouldRetry/429_with_unparseable_Retry-After_falls_back 2026/07/07 02:28:48 NOTICE: zoho root '': Failed to parse Retry-After: "soon": strconv.Atoi: parsing "soon": invalid syntax 2026/07/07 02:28:48 NOTICE: zoho root '': Too many requests: Trying again in 61 seconds. assert.AnError general error for testing === RUN TestShouldRetry/401_missing_scope_aborts 2026/07/07 02:28:48 ERROR : zoho: missing OAuth Scope. Run rclone config reconnect to fix this issue. === RUN TestShouldRetry/401_expired_token_retries === RUN TestShouldRetry/cancelled_context_aborts --- PASS: TestShouldRetry (0.00s) --- PASS: TestShouldRetry/429_honours_Retry-After (0.00s) --- PASS: TestShouldRetry/429_without_Retry-After_falls_back_to_60s (0.00s) --- PASS: TestShouldRetry/429_with_unparseable_Retry-After_falls_back (0.00s) --- PASS: TestShouldRetry/401_missing_scope_aborts (0.00s) --- PASS: TestShouldRetry/401_expired_token_retries (0.00s) --- PASS: TestShouldRetry/cancelled_context_aborts (0.00s) === RUN TestThrottleEpisode 2026/07/07 02:28:48 NOTICE: zoho root '': Too many requests: Trying again in 2 seconds. assert.AnError general error for testing --- PASS: TestThrottleEpisode (0.00s) === RUN TestThrottleStateConcurrent 2026/07/07 02:28:48 NOTICE: zoho root '': Too many requests: Trying again in 2 seconds. assert.AnError general error for testing --- PASS: TestThrottleStateConcurrent (0.00s) === RUN TestIntegration fstests.go:438: Using remote "TestZoho:" 2026/07/07 02:28:48 DEBUG : Creating backend with remote "TestZoho:rclone-test-gicixob8wiza" 2026/07/07 02:28:48 DEBUG : Using config file from "/home/rclone/.rclone.conf" 2026/07/07 02:28:48 DEBUG : zoho root 'rclone-test-gicixob8wiza': folder listing limiter sweep: evicted 0 of 0 idle limiters 2026/07/07 02:28:48 DEBUG : TestZoho: Token expired 2026/07/07 02:28:48 DEBUG : TestZoho: No updated token found in the config file 2026/07/07 02:28:48 DEBUG : TestZoho: Token refresh successful 2026/07/07 02:28:48 DEBUG : Saving config "token" in section "TestZoho" of the config file 2026/07/07 02:28:48 DEBUG : TestZoho: Saved new token in config file === RUN TestIntegration/FsCheckWrap fstests.go:479: Not a wrapping Fs === RUN TestIntegration/FsCommand fstests.go:507: No commands in this remote === RUN TestIntegration/FsRmdirNotFound 2026/07/07 02:28:49 DEBUG : pacer: Reducing sleep to 25.905286ms 2026/07/07 02:28:49 DEBUG : pacer: Reducing sleep to 58.009405ms 2026/07/07 02:28:49 DEBUG : pacer: Reducing sleep to 30.436235ms 2026/07/07 02:28:49 DEBUG : pacer: Reducing sleep to 150.085486ms === RUN TestIntegration/FsString === RUN TestIntegration/FsName === RUN TestIntegration/FsRoot === RUN TestIntegration/FsRmdirEmpty 2026/07/07 02:28:49 DEBUG : pacer: Reducing sleep to 263.676181ms 2026/07/07 02:28:49 DEBUG : pacer: Reducing sleep to 269.554387ms === RUN TestIntegration/FsMkdir 2026/07/07 02:28:50 DEBUG : pacer: Reducing sleep to 99.720365ms 2026/07/07 02:28:50 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:28:50 DEBUG : pacer: Reducing sleep to 115.715736ms === RUN TestIntegration/FsMkdir/FsMkdirRmdirSubdir 2026/07/07 02:28:50 INFO : dir/subdir: Making directory 2026/07/07 02:28:50 DEBUG : pacer: Reducing sleep to 234.942381ms 2026/07/07 02:28:50 DEBUG : pacer: Reducing sleep to 249.198368ms 2026/07/07 02:28:50 DEBUG : pacer: Reducing sleep to 217.559766ms 2026/07/07 02:28:51 DEBUG : pacer: Reducing sleep to 101.347778ms 2026/07/07 02:28:51 DEBUG : pacer: Reducing sleep to 69.484004ms 2026/07/07 02:28:51 DEBUG : pacer: Reducing sleep to 134.462724ms 2026/07/07 02:28:51 DEBUG : pacer: Reducing sleep to 242.79521ms 2026/07/07 02:28:51 INFO : dir/subdir: Removing directory 2026/07/07 02:28:51 DEBUG : pacer: Reducing sleep to 266.516468ms 2026/07/07 02:28:51 DEBUG : pacer: Reducing sleep to 181.370567ms 2026/07/07 02:28:52 DEBUG : pacer: Reducing sleep to 81.230316ms 2026/07/07 02:28:52 DEBUG : pacer: Reducing sleep to 80.848892ms 2026/07/07 02:28:52 INFO : dir: Removing directory 2026/07/07 02:28:52 DEBUG : pacer: Reducing sleep to 155.973593ms 2026/07/07 02:28:52 DEBUG : pacer: Reducing sleep to 237.272317ms 2026/07/07 02:28:52 DEBUG : pacer: Reducing sleep to 256.04454ms === RUN TestIntegration/FsMkdir/FsListEmpty 2026/07/07 02:28:52 DEBUG : pacer: Reducing sleep to 190.243688ms === RUN TestIntegration/FsMkdir/FsListDirEmpty 2026/07/07 02:28:57 DEBUG : pacer: Reducing sleep to 0s === RUN TestIntegration/FsMkdir/FsListRDirEmpty fstests.go:399: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsListDirNotFound 2026/07/07 02:29:01 ERROR : does not exist: error listing: directory not found === RUN TestIntegration/FsMkdir/FsListRDirNotFound fstests.go:399: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsEncoding === RUN TestIntegration/FsMkdir/FsEncoding/control_chars fstests.go:708: testing "␀␁␂␃␄␅␆␇␈␉␊␋␌␍␎␏␐␑␒␓␔␕␖␗␘␙␚␛␜␝␞␟␡" 2026/07/07 02:29:11 DEBUG : pacer: Reducing sleep to 90.97367ms 2026/07/07 02:29:11 DEBUG : pacer: Reducing sleep to 211.7963ms 2026/07/07 02:29:11 DEBUG : pacer: Reducing sleep to 112.576248ms 2026/07/07 02:29:11 DEBUG : pacer: Reducing sleep to 220.993503ms 2026/07/07 02:29:15 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:29:15 DEBUG : pacer: Reducing sleep to 104.905958ms 2026/07/07 02:29:15 DEBUG : pacer: Reducing sleep to 103.833317ms 2026/07/07 02:29:15 DEBUG : pacer: Reducing sleep to 172.336351ms 2026/07/07 02:29:16 DEBUG : pacer: Reducing sleep to 220.026288ms 2026/07/07 02:29:20 DEBUG : pacer: Reducing sleep to 0s === RUN TestIntegration/FsMkdir/FsEncoding/dot fstests.go:708: testing "." 2026/07/07 02:29:24 DEBUG : pacer: Reducing sleep to 94.77865ms 2026/07/07 02:29:25 DEBUG : pacer: Reducing sleep to 213.710584ms 2026/07/07 02:29:25 DEBUG : pacer: Reducing sleep to 174.635934ms 2026/07/07 02:29:25 DEBUG : pacer: Reducing sleep to 233.501286ms 2026/07/07 02:29:29 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:29:29 DEBUG : pacer: Reducing sleep to 111.241371ms 2026/07/07 02:29:29 DEBUG : pacer: Reducing sleep to 86.281314ms 2026/07/07 02:29:29 DEBUG : pacer: Reducing sleep to 155.286075ms 2026/07/07 02:29:29 DEBUG : pacer: Reducing sleep to 224.08543ms 2026/07/07 02:29:34 DEBUG : pacer: Reducing sleep to 0s === RUN TestIntegration/FsMkdir/FsEncoding/dot_dot fstests.go:708: testing ".." 2026/07/07 02:29:38 DEBUG : pacer: Reducing sleep to 86.420978ms 2026/07/07 02:29:38 DEBUG : pacer: Reducing sleep to 207.770258ms 2026/07/07 02:29:39 DEBUG : pacer: Reducing sleep to 131.870628ms 2026/07/07 02:29:39 DEBUG : pacer: Reducing sleep to 232.849929ms 2026/07/07 02:29:43 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:29:43 DEBUG : pacer: Reducing sleep to 109.675229ms 2026/07/07 02:29:43 DEBUG : pacer: Reducing sleep to 90.662338ms 2026/07/07 02:29:43 DEBUG : pacer: Reducing sleep to 162.881009ms 2026/07/07 02:29:43 DEBUG : pacer: Reducing sleep to 231.166526ms 2026/07/07 02:29:47 DEBUG : pacer: Reducing sleep to 0s === RUN TestIntegration/FsMkdir/FsEncoding/punctuation fstests.go:708: testing "!\"#$%&'()*+,-./:;<=>?@[\\]^_`{|}~" 2026/07/07 02:29:52 DEBUG : pacer: Reducing sleep to 78.116476ms 2026/07/07 02:29:52 DEBUG : zoho root 'rclone-test-gicixob8wiza': folder listing limiter sweep: evicted 4 of 8 idle limiters 2026/07/07 02:29:52 DEBUG : pacer: Reducing sleep to 196.731056ms 2026/07/07 02:29:52 DEBUG : pacer: Reducing sleep to 178.546305ms 2026/07/07 02:29:53 DEBUG : pacer: Reducing sleep to 240.400357ms 2026/07/07 02:29:53 DEBUG : pacer: Reducing sleep to 237.287957ms 2026/07/07 02:29:53 DEBUG : pacer: Reducing sleep to 162.986183ms 2026/07/07 02:29:53 DEBUG : pacer: Reducing sleep to 83.461639ms 2026/07/07 02:29:53 DEBUG : pacer: Reducing sleep to 94.563671ms 2026/07/07 02:29:53 DEBUG : pacer: Reducing sleep to 173.239974ms 2026/07/07 02:29:53 DEBUG : pacer: Reducing sleep to 253.536373ms === RUN TestIntegration/FsMkdir/FsEncoding/leading_space fstests.go:708: testing " leading space" 2026/07/07 02:29:54 DEBUG : pacer: Reducing sleep to 247.599169ms 2026/07/07 02:29:54 DEBUG : pacer: Reducing sleep to 126.676232ms 2026/07/07 02:29:54 DEBUG : pacer: Reducing sleep to 78.434326ms 2026/07/07 02:29:54 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:29:54 DEBUG : pacer: Reducing sleep to 113.698798ms 2026/07/07 02:29:55 DEBUG : pacer: Reducing sleep to 230.551891ms 2026/07/07 02:29:55 DEBUG : pacer: Reducing sleep to 277.474762ms 2026/07/07 02:29:55 DEBUG : pacer: Reducing sleep to 210.94516ms 2026/07/07 02:29:55 DEBUG : pacer: Reducing sleep to 100.945244ms 2026/07/07 02:29:55 DEBUG : pacer: Reducing sleep to 51.31194ms 2026/07/07 02:29:55 DEBUG : pacer: Reducing sleep to 132.94616ms === RUN TestIntegration/FsMkdir/FsEncoding/leading_tilde fstests.go:708: testing "~leading tilde" 2026/07/07 02:30:00 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:30:00 DEBUG : pacer: Reducing sleep to 51.503889ms 2026/07/07 02:30:00 DEBUG : pacer: Reducing sleep to 155.370092ms 2026/07/07 02:30:00 DEBUG : pacer: Reducing sleep to 184.869688ms 2026/07/07 02:30:00 DEBUG : pacer: Reducing sleep to 274.191269ms 2026/07/07 02:30:05 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:30:05 DEBUG : pacer: Reducing sleep to 111.108998ms 2026/07/07 02:30:05 DEBUG : pacer: Reducing sleep to 53.404974ms 2026/07/07 02:30:05 DEBUG : pacer: Reducing sleep to 117.064072ms 2026/07/07 02:30:05 DEBUG : pacer: Reducing sleep to 222.438396ms 2026/07/07 02:30:09 DEBUG : pacer: Reducing sleep to 0s === RUN TestIntegration/FsMkdir/FsEncoding/leading_CR fstests.go:708: testing "␍leading CR" 2026/07/07 02:30:14 DEBUG : pacer: Reducing sleep to 89.700662ms 2026/07/07 02:30:14 DEBUG : pacer: Reducing sleep to 210.685679ms 2026/07/07 02:30:14 DEBUG : pacer: Reducing sleep to 202.898318ms 2026/07/07 02:30:14 DEBUG : pacer: Reducing sleep to 231.241191ms 2026/07/07 02:30:19 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:30:19 DEBUG : pacer: Reducing sleep to 104.984549ms 2026/07/07 02:30:19 DEBUG : pacer: Reducing sleep to 89.979923ms 2026/07/07 02:30:19 DEBUG : pacer: Reducing sleep to 159.635096ms 2026/07/07 02:30:19 DEBUG : pacer: Reducing sleep to 230.028908ms 2026/07/07 02:30:23 DEBUG : pacer: Reducing sleep to 0s === RUN TestIntegration/FsMkdir/FsEncoding/leading_LF fstests.go:708: testing "␊leading LF" 2026/07/07 02:30:28 DEBUG : pacer: Reducing sleep to 92.647304ms 2026/07/07 02:30:28 DEBUG : pacer: Reducing sleep to 209.527132ms 2026/07/07 02:30:28 DEBUG : pacer: Reducing sleep to 132.703755ms 2026/07/07 02:30:28 DEBUG : pacer: Reducing sleep to 238.090764ms 2026/07/07 02:30:32 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:30:32 DEBUG : pacer: Reducing sleep to 103.376716ms 2026/07/07 02:30:33 DEBUG : pacer: Reducing sleep to 84.970447ms 2026/07/07 02:30:33 DEBUG : pacer: Reducing sleep to 155.916569ms 2026/07/07 02:30:33 DEBUG : pacer: Reducing sleep to 231.644881ms 2026/07/07 02:30:37 DEBUG : pacer: Reducing sleep to 0s === RUN TestIntegration/FsMkdir/FsEncoding/leading_HT fstests.go:708: testing "␉leading HT" 2026/07/07 02:30:42 DEBUG : pacer: Reducing sleep to 86.996298ms 2026/07/07 02:30:42 DEBUG : pacer: Reducing sleep to 208.393201ms 2026/07/07 02:30:42 DEBUG : pacer: Reducing sleep to 199.505975ms 2026/07/07 02:30:42 DEBUG : pacer: Reducing sleep to 233.443934ms 2026/07/07 02:30:46 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:30:46 DEBUG : pacer: Reducing sleep to 101.006885ms 2026/07/07 02:30:46 DEBUG : pacer: Reducing sleep to 91.639101ms 2026/07/07 02:30:47 DEBUG : pacer: Reducing sleep to 165.126062ms 2026/07/07 02:30:47 DEBUG : pacer: Reducing sleep to 235.264976ms 2026/07/07 02:30:51 DEBUG : pacer: Reducing sleep to 0s === RUN TestIntegration/FsMkdir/FsEncoding/leading_VT fstests.go:708: testing "␋leading VT" 2026/07/07 02:30:51 DEBUG : pacer: Reducing sleep to 120.979548ms 2026/07/07 02:30:51 DEBUG : pacer: Reducing sleep to 37.716556ms 2026/07/07 02:30:51 DEBUG : pacer: Reducing sleep to 146.218636ms 2026/07/07 02:30:51 DEBUG : pacer: Reducing sleep to 129.956265ms 2026/07/07 02:30:51 DEBUG : pacer: Reducing sleep to 234.350077ms 2026/07/07 02:30:53 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:30:53 DEBUG : zoho root 'rclone-test-gicixob8wiza': folder listing limiter sweep: evicted 3 of 11 idle limiters 2026/07/07 02:30:53 DEBUG : pacer: Reducing sleep to 110.534626ms 2026/07/07 02:30:53 DEBUG : pacer: Reducing sleep to 90.038511ms 2026/07/07 02:30:53 DEBUG : pacer: Reducing sleep to 150.057847ms 2026/07/07 02:30:53 DEBUG : pacer: Reducing sleep to 222.933852ms 2026/07/07 02:30:53 DEBUG : pacer: Reducing sleep to 245.158723ms === RUN TestIntegration/FsMkdir/FsEncoding/leading_dot fstests.go:708: testing ".leading dot" 2026/07/07 02:30:54 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:30:54 DEBUG : pacer: Reducing sleep to 88.316441ms 2026/07/07 02:30:54 DEBUG : pacer: Reducing sleep to 87.510616ms 2026/07/07 02:30:54 DEBUG : pacer: Reducing sleep to 72.598609ms 2026/07/07 02:30:54 DEBUG : pacer: Reducing sleep to 182.296832ms 2026/07/07 02:30:55 DEBUG : pacer: Reducing sleep to 280.563325ms 2026/07/07 02:30:55 DEBUG : pacer: Reducing sleep to 258.795561ms 2026/07/07 02:30:55 DEBUG : pacer: Reducing sleep to 140.999767ms 2026/07/07 02:30:55 DEBUG : pacer: Reducing sleep to 56.094839ms 2026/07/07 02:30:55 DEBUG : pacer: Reducing sleep to 74.823734ms 2026/07/07 02:30:59 DEBUG : pacer: Reducing sleep to 0s === RUN TestIntegration/FsMkdir/FsEncoding/trailing_space fstests.go:708: testing "trailing space " 2026/07/07 02:31:04 DEBUG : pacer: Reducing sleep to 89.258507ms 2026/07/07 02:31:04 DEBUG : pacer: Reducing sleep to 205.58721ms 2026/07/07 02:31:04 DEBUG : pacer: Reducing sleep to 164.035471ms 2026/07/07 02:31:04 DEBUG : pacer: Reducing sleep to 239.756097ms 2026/07/07 02:31:08 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:31:08 DEBUG : pacer: Reducing sleep to 112.115906ms 2026/07/07 02:31:09 DEBUG : pacer: Reducing sleep to 82.949769ms 2026/07/07 02:31:09 DEBUG : pacer: Reducing sleep to 158.786587ms 2026/07/07 02:31:09 DEBUG : pacer: Reducing sleep to 222.624788ms 2026/07/07 02:31:13 DEBUG : pacer: Reducing sleep to 0s === RUN TestIntegration/FsMkdir/FsEncoding/trailing_CR fstests.go:708: testing "trailing CR␍" 2026/07/07 02:31:18 DEBUG : pacer: Reducing sleep to 76.991546ms 2026/07/07 02:31:18 DEBUG : pacer: Reducing sleep to 197.731692ms 2026/07/07 02:31:18 DEBUG : pacer: Reducing sleep to 145.501663ms 2026/07/07 02:31:18 DEBUG : pacer: Reducing sleep to 243.370359ms 2026/07/07 02:31:22 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:31:22 DEBUG : pacer: Reducing sleep to 108.092411ms 2026/07/07 02:31:22 DEBUG : pacer: Reducing sleep to 78.232756ms 2026/07/07 02:31:23 DEBUG : pacer: Reducing sleep to 144.58122ms 2026/07/07 02:31:23 DEBUG : pacer: Reducing sleep to 227.707121ms 2026/07/07 02:31:27 DEBUG : pacer: Reducing sleep to 0s === RUN TestIntegration/FsMkdir/FsEncoding/trailing_LF fstests.go:708: testing "trailing LF␊" 2026/07/07 02:31:31 DEBUG : pacer: Reducing sleep to 89.828714ms 2026/07/07 02:31:32 DEBUG : pacer: Reducing sleep to 206.311878ms 2026/07/07 02:31:32 DEBUG : pacer: Reducing sleep to 132.524291ms 2026/07/07 02:31:32 DEBUG : pacer: Reducing sleep to 235.573479ms 2026/07/07 02:31:36 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:31:36 DEBUG : pacer: Reducing sleep to 102.429083ms 2026/07/07 02:31:36 DEBUG : pacer: Reducing sleep to 88.635621ms 2026/07/07 02:31:36 DEBUG : pacer: Reducing sleep to 160.321385ms 2026/07/07 02:31:36 DEBUG : pacer: Reducing sleep to 230.797364ms 2026/07/07 02:31:41 DEBUG : pacer: Reducing sleep to 0s === RUN TestIntegration/FsMkdir/FsEncoding/trailing_HT fstests.go:708: testing "trailing HT␉" 2026/07/07 02:31:45 DEBUG : pacer: Reducing sleep to 86.713219ms 2026/07/07 02:31:45 DEBUG : pacer: Reducing sleep to 206.814624ms 2026/07/07 02:31:46 DEBUG : pacer: Reducing sleep to 208.547401ms 2026/07/07 02:31:46 DEBUG : pacer: Reducing sleep to 234.862476ms 2026/07/07 02:31:50 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:31:50 DEBUG : pacer: Reducing sleep to 108.338476ms 2026/07/07 02:31:50 DEBUG : pacer: Reducing sleep to 90.87222ms 2026/07/07 02:31:50 DEBUG : pacer: Reducing sleep to 153.645906ms 2026/07/07 02:31:50 DEBUG : pacer: Reducing sleep to 225.412482ms 2026/07/07 02:31:50 DEBUG : pacer: Reducing sleep to 245.850313ms === RUN TestIntegration/FsMkdir/FsEncoding/trailing_VT fstests.go:708: testing "trailing VT␋" 2026/07/07 02:31:51 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:31:51 DEBUG : pacer: Reducing sleep to 86.555005ms 2026/07/07 02:31:52 DEBUG : pacer: Reducing sleep to 81.62216ms 2026/07/07 02:31:52 DEBUG : pacer: Reducing sleep to 42.865915ms 2026/07/07 02:31:52 DEBUG : pacer: Reducing sleep to 153.354717ms 2026/07/07 02:31:52 DEBUG : pacer: Reducing sleep to 268.968178ms 2026/07/07 02:31:52 DEBUG : pacer: Reducing sleep to 277.054146ms 2026/07/07 02:31:52 DEBUG : pacer: Reducing sleep to 168.692868ms 2026/07/07 02:31:53 DEBUG : pacer: Reducing sleep to 68.233043ms 2026/07/07 02:31:53 DEBUG : pacer: Reducing sleep to 59.008988ms 2026/07/07 02:31:53 DEBUG : zoho root 'rclone-test-gicixob8wiza': folder listing limiter sweep: evicted 7 of 14 idle limiters 2026/07/07 02:31:53 DEBUG : pacer: Reducing sleep to 0s === RUN TestIntegration/FsMkdir/FsEncoding/trailing_dot fstests.go:708: testing "trailing dot." 2026/07/07 02:31:54 DEBUG : pacer: Reducing sleep to 59.76503ms 2026/07/07 02:31:54 DEBUG : pacer: Reducing sleep to 180.668785ms 2026/07/07 02:31:54 DEBUG : pacer: Reducing sleep to 200.124322ms 2026/07/07 02:31:54 DEBUG : pacer: Reducing sleep to 260.817958ms 2026/07/07 02:31:58 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:31:58 DEBUG : pacer: Reducing sleep to 106.553932ms 2026/07/07 02:31:58 DEBUG : pacer: Reducing sleep to 62.92105ms 2026/07/07 02:31:59 DEBUG : pacer: Reducing sleep to 132.766695ms 2026/07/07 02:31:59 DEBUG : pacer: Reducing sleep to 228.571155ms 2026/07/07 02:32:03 DEBUG : pacer: Reducing sleep to 0s === RUN TestIntegration/FsMkdir/FsEncoding/invalid_UTF-8 fstests.go:699: Skipping invalid UTF-8 === RUN TestIntegration/FsMkdir/FsEncoding/URL_encoding fstests.go:708: testing "test%46.txt" 2026/07/07 02:32:08 DEBUG : pacer: Reducing sleep to 82.069845ms 2026/07/07 02:32:08 DEBUG : pacer: Reducing sleep to 191.514839ms 2026/07/07 02:32:08 DEBUG : pacer: Reducing sleep to 196.219351ms 2026/07/07 02:32:08 DEBUG : pacer: Reducing sleep to 250.361321ms 2026/07/07 02:32:12 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:32:12 DEBUG : pacer: Reducing sleep to 108.425766ms 2026/07/07 02:32:12 DEBUG : pacer: Reducing sleep to 53.61162ms 2026/07/07 02:32:12 DEBUG : pacer: Reducing sleep to 138.693687ms 2026/07/07 02:32:12 DEBUG : pacer: Reducing sleep to 245.182971ms 2026/07/07 02:32:17 DEBUG : pacer: Reducing sleep to 0s === RUN TestIntegration/FsMkdir/FsNewObjectNotFound === RUN TestIntegration/FsMkdir/FsPutError 2026/07/07 02:32:35 DEBUG : pacer: Reducing sleep to 100.069316ms 2026/07/07 02:32:35 DEBUG : pacer: Reducing sleep to 217.992966ms 2026/07/07 02:32:35 DEBUG : pacer: Reducing sleep to 253.866432ms 2026/07/07 02:32:36 DEBUG : pacer: Reducing sleep to 217.75265ms 2026/07/07 02:32:36 DEBUG : pacer: Reducing sleep to 119.192999ms 2026/07/07 02:32:36 DEBUG : pacer: Reducing sleep to 92.480331ms 2026/07/07 02:32:36 DEBUG : pacer: Reducing sleep to 113.92066ms 2026/07/07 02:32:36 DEBUG : pacer: Reducing sleep to 262.475878ms 2026/07/07 02:32:36 DEBUG : pacer: Reducing sleep to 265.760816ms === RUN TestIntegration/FsMkdir/FsPutZeroLength 2026/07/07 02:32:40 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:32:45 DEBUG : Couldn't parse Date: from server download.zoho.eu: "Tue, 07 Jul 2026 02:32:45 UTC": parsing time "Tue, 07 Jul 2026 02:32:45 UTC" as "Mon Jan _2 15:04:05 2006": cannot parse ", 07 Jul 2026 02:32:45 UTC" as " " 2026/07/07 02:32:45 DEBUG : pacer: Reducing sleep to 97.586291ms === RUN TestIntegration/FsMkdir/FsOpenWriterAt fstests.go:787: FS has no OpenWriterAt interface === RUN TestIntegration/FsMkdir/FsOpenChunkWriter fstests.go:820: FS has no OpenChunkWriter interface === RUN TestIntegration/FsMkdir/FsChangeNotify fstests.go:873: FS has no ChangeNotify interface === RUN TestIntegration/FsMkdir/FsPutFiles 2026/07/07 02:32:49 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:32:49 DEBUG : pacer: Reducing sleep to 38.071679ms 2026/07/07 02:32:54 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:32:54 DEBUG : zoho root 'rclone-test-gicixob8wiza': folder listing limiter sweep: evicted 6 of 13 idle limiters 2026/07/07 02:32:54 DEBUG : pacer: Reducing sleep to 102.26297ms 2026/07/07 02:32:54 DEBUG : pacer: Reducing sleep to 49.559518ms 2026/07/07 02:32:54 DEBUG : pacer: Reducing sleep to 163.69029ms 2026/07/07 02:32:54 DEBUG : pacer: Reducing sleep to 274.899214ms 2026/07/07 02:32:54 DEBUG : pacer: Reducing sleep to 226.064319ms 2026/07/07 02:32:54 DEBUG : pacer: Reducing sleep to 174.10306ms === RUN TestIntegration/FsMkdir/FsPutFiles/FsListDirFile2 2026/07/07 02:32:55 DEBUG : pacer: Reducing sleep to 104.640755ms 2026/07/07 02:32:55 DEBUG : pacer: Reducing sleep to 99.677957ms 2026/07/07 02:32:55 DEBUG : pacer: Reducing sleep to 156.071795ms 2026/07/07 02:32:55 DEBUG : pacer: Reducing sleep to 228.038792ms 2026/07/07 02:32:55 DEBUG : pacer: Reducing sleep to 231.802668ms === RUN TestIntegration/FsMkdir/FsPutFiles/FsListRDirFile2 fstests.go:399: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsPutFiles/FsListR 2026/07/07 02:32:55 DEBUG : pacer: Reducing sleep to 175.892513ms 2026/07/07 02:32:56 DEBUG : pacer: Reducing sleep to 88.013271ms 2026/07/07 02:32:56 DEBUG : pacer: Reducing sleep to 101.17329ms 2026/07/07 02:32:56 DEBUG : pacer: Reducing sleep to 172.415204ms 2026/07/07 02:32:56 DEBUG : pacer: Reducing sleep to 242.593569ms === RUN TestIntegration/FsMkdir/FsPutFiles/FsListRSubdir 2026/07/07 02:32:56 DEBUG : pacer: Reducing sleep to 234.075112ms 2026/07/07 02:32:56 DEBUG : pacer: Reducing sleep to 161.374459ms 2026/07/07 02:32:57 DEBUG : pacer: Reducing sleep to 91.300728ms 2026/07/07 02:32:57 DEBUG : pacer: Reducing sleep to 94.170794ms === RUN TestIntegration/FsMkdir/FsPutFiles/FsListDirRoot 2026/07/07 02:32:57 DEBUG : Creating backend with remote "TestZoho:" 2026/07/07 02:32:57 DEBUG : Config file has changed externally - reloading === RUN TestIntegration/FsMkdir/FsPutFiles/FsListRDirRoot fstests.go:399: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsPutFiles/FsListSubdir 2026/07/07 02:33:01 DEBUG : pacer: Reducing sleep to 0s === RUN TestIntegration/FsMkdir/FsPutFiles/FsListRSubdir#01 fstests.go:399: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsPutFiles/FsListLevel2 2026/07/07 02:33:06 DEBUG : pacer: Reducing sleep to 110.155299ms 2026/07/07 02:33:06 DEBUG : pacer: Reducing sleep to 225.199361ms === RUN TestIntegration/FsMkdir/FsPutFiles/FsListRLevel2 fstests.go:399: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsPutFiles/FsListFile1 2026/07/07 02:33:11 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:33:11 DEBUG : pacer: Reducing sleep to 115.898982ms 2026/07/07 02:33:11 DEBUG : pacer: Reducing sleep to 110.55362ms 2026/07/07 02:33:11 DEBUG : pacer: Reducing sleep to 163.423568ms 2026/07/07 02:33:11 DEBUG : pacer: Reducing sleep to 213.007105ms === RUN TestIntegration/FsMkdir/FsPutFiles/FsNewObject 2026/07/07 02:33:15 DEBUG : pacer: Reducing sleep to 0s === RUN TestIntegration/FsMkdir/FsPutFiles/FsNewObjectCaseInsensitive fstests.go:1126: Not Case Insensitive === RUN TestIntegration/FsMkdir/FsPutFiles/FsListFile1and2 2026/07/07 02:33:20 DEBUG : pacer: Reducing sleep to 113.37619ms 2026/07/07 02:33:20 DEBUG : pacer: Reducing sleep to 224.010163ms 2026/07/07 02:33:20 DEBUG : pacer: Reducing sleep to 276.965628ms 2026/07/07 02:33:20 DEBUG : pacer: Reducing sleep to 219.132315ms === RUN TestIntegration/FsMkdir/FsPutFiles/FsNewObjectDir 2026/07/07 02:33:25 DEBUG : pacer: Reducing sleep to 0s === RUN TestIntegration/FsMkdir/FsPutFiles/FsPurge 2026/07/07 02:33:25 DEBUG : pacer: Reducing sleep to 113.840705ms 2026/07/07 02:33:29 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:33:29 DEBUG : pacer: Reducing sleep to 93.325352ms 2026/07/07 02:33:30 DEBUG : pacer: Reducing sleep to 14.909612ms 2026/07/07 02:33:30 DEBUG : pacer: Reducing sleep to 23.591088ms 2026/07/07 02:33:34 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:33:34 DEBUG : pacer: Reducing sleep to 114.263112ms 2026/07/07 02:33:34 DEBUG : pacer: Reducing sleep to 271.961743ms 2026/07/07 02:33:34 DEBUG : pacer: Reducing sleep to 397.206467ms 2026/07/07 02:33:34 DEBUG : pacer: Reducing sleep to 442.02116ms 2026/07/07 02:33:35 DEBUG : pacer: Reducing sleep to 214.419876ms 2026/07/07 02:33:35 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:33:35 DEBUG : pacer: Reducing sleep to 107.898392ms 2026/07/07 02:33:39 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:33:39 DEBUG : pacer: Reducing sleep to 114.171119ms 2026/07/07 02:33:39 DEBUG : pacer: Reducing sleep to 224.503731ms 2026/07/07 02:33:39 DEBUG : pacer: Reducing sleep to 282.195182ms 2026/07/07 02:33:39 DEBUG : pacer: Reducing sleep to 219.182593ms === RUN TestIntegration/FsMkdir/FsPutFiles/FsPurgeRoot 2026/07/07 02:33:43 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:33:48 DEBUG : pacer: Reducing sleep to 98.516022ms 2026/07/07 02:33:48 DEBUG : pacer: Reducing sleep to 92.196779ms 2026/07/07 02:33:48 DEBUG : pacer: Reducing sleep to 202.487304ms 2026/07/07 02:33:52 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:33:52 DEBUG : pacer: Reducing sleep to 112.634944ms 2026/07/07 02:33:52 DEBUG : pacer: Reducing sleep to 277.629687ms 2026/07/07 02:33:53 DEBUG : pacer: Reducing sleep to 289.603902ms 2026/07/07 02:33:53 DEBUG : pacer: Reducing sleep to 183.642308ms 2026/07/07 02:33:53 DEBUG : pacer: Reducing sleep to 55.62666ms 2026/07/07 02:33:53 DEBUG : Creating backend with remote "TestZoho:rclone-test-gicixob8wiza/dirToPurgeFromRoot" 2026/07/07 02:33:54 DEBUG : zoho root 'rclone-test-gicixob8wiza/dirToPurgeFromRoot': folder listing limiter sweep: evicted 2 of 10 idle limiters 2026/07/07 02:33:54 DEBUG : pacer: Reducing sleep to 109.671552ms 2026/07/07 02:33:54 DEBUG : pacer: Reducing sleep to 228.534499ms 2026/07/07 02:33:54 DEBUG : pacer: Reducing sleep to 269.253952ms 2026/07/07 02:33:54 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:33:54 DEBUG : pacer: Reducing sleep to 111.917065ms 2026/07/07 02:33:54 DEBUG : pacer: Reducing sleep to 227.578812ms 2026/07/07 02:33:54 DEBUG : pacer: Reducing sleep to 273.562686ms 2026/07/07 02:33:55 DEBUG : pacer: Reducing sleep to 218.568873ms === RUN TestIntegration/FsMkdir/FsPutFiles/FsListRootedSubdir 2026/07/07 02:33:55 DEBUG : Creating backend with remote "TestZoho:rclone-test-gicixob8wiza/hello? sausage/êé" 2026/07/07 02:33:55 DEBUG : pacer: Reducing sleep to 112.848717ms 2026/07/07 02:33:55 DEBUG : pacer: Reducing sleep to 226.560768ms 2026/07/07 02:33:55 DEBUG : pacer: Reducing sleep to 276.584047ms 2026/07/07 02:33:55 DEBUG : pacer: Reducing sleep to 215.401518ms 2026/07/07 02:33:56 DEBUG : pacer: Reducing sleep to 74.316836ms 2026/07/07 02:33:56 DEBUG : pacer: Reducing sleep to 65.277395ms 2026/07/07 02:33:56 DEBUG : pacer: Reducing sleep to 130.127229ms 2026/07/07 02:33:56 DEBUG : pacer: Reducing sleep to 248.669424ms 2026/07/07 02:33:56 DEBUG : pacer: Reducing sleep to 261.407526ms 2026/07/07 02:33:56 DEBUG : pacer: Reducing sleep to 197.236648ms 2026/07/07 02:33:57 DEBUG : pacer: Reducing sleep to 81.287705ms 2026/07/07 02:33:57 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:33:57 DEBUG : pacer: Reducing sleep to 112.941833ms 2026/07/07 02:33:57 DEBUG : pacer: Reducing sleep to 229.057455ms 2026/07/07 02:33:57 DEBUG : pacer: Reducing sleep to 269.23971ms 2026/07/07 02:33:57 DEBUG : pacer: Reducing sleep to 218.595851ms 2026/07/07 02:33:58 DEBUG : pacer: Reducing sleep to 88.330469ms 2026/07/07 02:33:58 DEBUG : pacer: Reducing sleep to 62.547132ms 2026/07/07 02:33:58 DEBUG : pacer: Reducing sleep to 132.24379ms 2026/07/07 02:33:58 DEBUG : pacer: Reducing sleep to 238.317979ms 2026/07/07 02:33:58 DEBUG : pacer: Reducing sleep to 270.164969ms 2026/07/07 02:33:58 DEBUG : pacer: Reducing sleep to 195.851218ms === RUN TestIntegration/FsMkdir/FsPutFiles/FsCopy 2026/07/07 02:33:58 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:33:59 DEBUG : pacer: Reducing sleep to 95.763679ms 2026/07/07 02:33:59 DEBUG : pacer: Reducing sleep to 206.725078ms 2026/07/07 02:33:59 DEBUG : pacer: Reducing sleep to 280.92649ms 2026/07/07 02:34:02 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:34:02 DEBUG : pacer: Reducing sleep to 107.544125ms 2026/07/07 02:34:02 DEBUG : pacer: Reducing sleep to 51.956212ms 2026/07/07 02:34:02 DEBUG : pacer: Reducing sleep to 81.60488ms === RUN TestIntegration/FsMkdir/FsPutFiles/FsCopy/Metadata fstests.go:1298: Skipping test as can't write metadata === RUN TestIntegration/FsMkdir/FsPutFiles/FsMove 2026/07/07 02:34:06 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:34:06 DEBUG : pacer: Reducing sleep to 103.878961ms 2026/07/07 02:34:07 DEBUG : pacer: Reducing sleep to 184.00721ms 2026/07/07 02:34:07 DEBUG : pacer: Reducing sleep to 273.645745ms 2026/07/07 02:34:07 DEBUG : pacer: Reducing sleep to 257.184726ms 2026/07/07 02:34:07 DEBUG : pacer: Reducing sleep to 157.934371ms 2026/07/07 02:34:07 DEBUG : pacer: Reducing sleep to 61.5414ms 2026/07/07 02:34:07 DEBUG : pacer: Reducing sleep to 74.290132ms 2026/07/07 02:34:11 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:34:16 DEBUG : pacer: Reducing sleep to 97.167295ms 2026/07/07 02:34:16 DEBUG : pacer: Reducing sleep to 194.917544ms 2026/07/07 02:34:16 DEBUG : pacer: Reducing sleep to 251.348326ms 2026/07/07 02:34:16 DEBUG : pacer: Reducing sleep to 239.816125ms 2026/07/07 02:34:21 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:34:21 DEBUG : pacer: Reducing sleep to 111.796085ms 2026/07/07 02:34:21 DEBUG : pacer: Reducing sleep to 276.921443ms 2026/07/07 02:34:21 DEBUG : pacer: Reducing sleep to 267.28949ms 2026/07/07 02:34:21 DEBUG : pacer: Reducing sleep to 155.967773ms 2026/07/07 02:34:21 DEBUG : pacer: Reducing sleep to 57.389089ms 2026/07/07 02:34:21 DEBUG : pacer: Reducing sleep to 65.76591ms 2026/07/07 02:34:22 DEBUG : pacer: Reducing sleep to 149.689441ms 2026/07/07 02:34:22 DEBUG : pacer: Reducing sleep to 232.619265ms 2026/07/07 02:34:22 DEBUG : pacer: Reducing sleep to 260.938426ms 2026/07/07 02:34:25 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:34:25 DEBUG : pacer: Reducing sleep to 113.668697ms 2026/07/07 02:34:25 DEBUG : pacer: Reducing sleep to 270.746421ms 2026/07/07 02:34:25 DEBUG : pacer: Reducing sleep to 235.397913ms 2026/07/07 02:34:26 DEBUG : pacer: Reducing sleep to 133.387472ms 2026/07/07 02:34:26 DEBUG : pacer: Reducing sleep to 60.80601ms 2026/07/07 02:34:30 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:34:30 DEBUG : pacer: Reducing sleep to 95.109999ms 2026/07/07 02:34:30 DEBUG : pacer: Reducing sleep to 80.887581ms 2026/07/07 02:34:30 DEBUG : pacer: Reducing sleep to 176.788769ms 2026/07/07 02:34:34 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:34:34 DEBUG : pacer: Reducing sleep to 122.691144ms 2026/07/07 02:34:34 DEBUG : pacer: Reducing sleep to 276.289438ms 2026/07/07 02:34:35 DEBUG : pacer: Reducing sleep to 331.206883ms 2026/07/07 02:34:35 DEBUG : pacer: Reducing sleep to 206.417308ms 2026/07/07 02:34:35 DEBUG : pacer: Reducing sleep to 54.319625ms 2026/07/07 02:34:35 DEBUG : pacer: Reducing sleep to 11.593943ms 2026/07/07 02:34:35 DEBUG : pacer: Reducing sleep to 117.682339ms === RUN TestIntegration/FsMkdir/FsPutFiles/FsMove/Metadata fstests.go:1407: Skipping test as can't write metadata === RUN TestIntegration/FsMkdir/FsPutFiles/FsDirMove 2026/07/07 02:34:35 DEBUG : Creating backend with remote "TestZoho:rclone-test-qemuquf2ciyi" 2026/07/07 02:34:36 DEBUG : pacer: Reducing sleep to 40.095013ms 2026/07/07 02:34:36 DEBUG : pacer: Reducing sleep to 75.598232ms 2026/07/07 02:34:36 DEBUG : pacer: Reducing sleep to 104.547368ms 2026/07/07 02:34:36 DEBUG : pacer: Reducing sleep to 220.04161ms 2026/07/07 02:34:36 DEBUG : pacer: Reducing sleep to 259.261057ms 2026/07/07 02:34:36 DEBUG : pacer: Reducing sleep to 228.075526ms 2026/07/07 02:34:37 DEBUG : pacer: Reducing sleep to 116.625127ms 2026/07/07 02:34:37 DEBUG : pacer: Reducing sleep to 51.270786ms 2026/07/07 02:34:37 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:34:37 DEBUG : pacer: Reducing sleep to 32.978961ms 2026/07/07 02:34:37 DEBUG : pacer: Reducing sleep to 150.234426ms 2026/07/07 02:34:39 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:34:39 DEBUG : pacer: Reducing sleep to 118.440644ms 2026/07/07 02:34:39 DEBUG : pacer: Reducing sleep to 188.393043ms 2026/07/07 02:34:39 DEBUG : pacer: Reducing sleep to 243.831688ms 2026/07/07 02:34:39 DEBUG : pacer: Reducing sleep to 202.091102ms 2026/07/07 02:34:41 DEBUG : pacer: Reducing sleep to 39.922031ms 2026/07/07 02:34:44 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:34:44 DEBUG : pacer: Reducing sleep to 92.548979ms 2026/07/07 02:34:44 DEBUG : pacer: Reducing sleep to 205.289105ms 2026/07/07 02:34:44 DEBUG : pacer: Reducing sleep to 271.723569ms 2026/07/07 02:34:44 DEBUG : pacer: Reducing sleep to 235.57831ms 2026/07/07 02:34:44 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:34:44 DEBUG : pacer: Reducing sleep to 123.47466ms 2026/07/07 02:34:44 DEBUG : zoho root 'rclone-test-qemuquf2ciyi': Purge remote 2026/07/07 02:34:44 DEBUG : pacer: Reducing sleep to 125.133525ms 2026/07/07 02:34:44 DEBUG : pacer: Reducing sleep to 170.303516ms === RUN TestIntegration/FsMkdir/FsPutFiles/FsRmdirFull 2026/07/07 02:34:44 DEBUG : pacer: Reducing sleep to 0s === RUN TestIntegration/FsMkdir/FsPutFiles/FsPrecision === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectString === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectFs === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectRemote 2026/07/07 02:34:53 DEBUG : pacer: Reducing sleep to 113.071592ms === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectHashes 2026/07/07 02:34:53 DEBUG : pacer: Reducing sleep to 220.897959ms === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectModTime 2026/07/07 02:34:53 DEBUG : pacer: Reducing sleep to 279.497948ms === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectMimeType 2026/07/07 02:34:53 DEBUG : pacer: Reducing sleep to 220.056352ms fstests.go:1601: MimeType method not supported === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectMetadata 2026/07/07 02:34:54 DEBUG : pacer: Reducing sleep to 0s fstests.go:1632: Metadata method not supported === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectSetMetadata 2026/07/07 02:34:54 DEBUG : zoho root 'rclone-test-gicixob8wiza': folder listing limiter sweep: evicted 2 of 15 idle limiters fstests.go:1703: SetMetadata method not supported === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectSetModTime fstests.go:1760: can't set modified time === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectSize === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectOpen 2026/07/07 02:35:13 DEBUG : Couldn't parse Date: from server download.zoho.eu: "Tue, 07 Jul 2026 02:35:13 UTC": parsing time "Tue, 07 Jul 2026 02:35:13 UTC" as "Mon Jan _2 15:04:05 2006": cannot parse ", 07 Jul 2026 02:35:13 UTC" as " " === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectOpenSeek 2026/07/07 02:35:18 DEBUG : Couldn't parse Date: from server download.zoho.eu: "Tue, 07 Jul 2026 02:35:18 UTC": parsing time "Tue, 07 Jul 2026 02:35:18 UTC" as "Mon Jan _2 15:04:05 2006": cannot parse ", 07 Jul 2026 02:35:18 UTC" as " " === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectOpenRange 2026/07/07 02:35:22 DEBUG : Couldn't parse Date: from server download.zoho.eu: "Tue, 07 Jul 2026 02:35:22 UTC": parsing time "Tue, 07 Jul 2026 02:35:22 UTC" as "Mon Jan _2 15:04:05 2006": cannot parse ", 07 Jul 2026 02:35:22 UTC" as " " 2026/07/07 02:35:22 DEBUG : Couldn't parse Date: from server download.zoho.eu: "Tue, 07 Jul 2026 02:35:22 UTC": parsing time "Tue, 07 Jul 2026 02:35:22 UTC" as "Mon Jan _2 15:04:05 2006": cannot parse ", 07 Jul 2026 02:35:22 UTC" as " " 2026/07/07 02:35:22 DEBUG : pacer: Reducing sleep to 2.667056ms 2026/07/07 02:35:23 DEBUG : Couldn't parse Date: from server download.zoho.eu: "Tue, 07 Jul 2026 02:35:23 UTC": parsing time "Tue, 07 Jul 2026 02:35:23 UTC" as "Mon Jan _2 15:04:05 2006": cannot parse ", 07 Jul 2026 02:35:23 UTC" as " " 2026/07/07 02:35:23 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:35:23 DEBUG : Couldn't parse Date: from server download.zoho.eu: "Tue, 07 Jul 2026 02:35:23 UTC": parsing time "Tue, 07 Jul 2026 02:35:23 UTC" as "Mon Jan _2 15:04:05 2006": cannot parse ", 07 Jul 2026 02:35:23 UTC" as " " === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectPartialRead 2026/07/07 02:35:27 DEBUG : Couldn't parse Date: from server download.zoho.eu: "Tue, 07 Jul 2026 02:35:27 UTC": parsing time "Tue, 07 Jul 2026 02:35:27 UTC" as "Mon Jan _2 15:04:05 2006": cannot parse ", 07 Jul 2026 02:35:27 UTC" as " " === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectUpdate 2026/07/07 02:35:31 DEBUG : pacer: Reducing sleep to 44.493334ms 2026/07/07 02:35:36 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:35:36 DEBUG : Couldn't parse Date: from server download.zoho.eu: "Tue, 07 Jul 2026 02:35:36 UTC": parsing time "Tue, 07 Jul 2026 02:35:36 UTC" as "Mon Jan _2 15:04:05 2006": cannot parse ", 07 Jul 2026 02:35:36 UTC" as " " 2026/07/07 02:35:36 DEBUG : pacer: Reducing sleep to 3.359368ms === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectStorable 2026/07/07 02:35:41 DEBUG : pacer: Reducing sleep to 0s === RUN TestIntegration/FsMkdir/FsPutFiles/FsIsFile 2026/07/07 02:35:41 DEBUG : Creating backend with remote "TestZoho:rclone-test-gicixob8wiza/hello? sausage/êé/Hello, 世界/ \" ' @ < > & ? + ≠/z.txt" 2026/07/07 02:35:45 DEBUG : pacer: Reducing sleep to 110.749947ms 2026/07/07 02:35:45 DEBUG : pacer: Reducing sleep to 225.189571ms 2026/07/07 02:35:45 DEBUG : pacer: Reducing sleep to 279.149428ms 2026/07/07 02:35:46 DEBUG : pacer: Reducing sleep to 214.613273ms 2026/07/07 02:35:46 DEBUG : pacer: Reducing sleep to 32.840303ms 2026/07/07 02:35:50 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:35:50 DEBUG : pacer: Reducing sleep to 103.547396ms 2026/07/07 02:35:50 DEBUG : pacer: Reducing sleep to 218.627707ms 2026/07/07 02:35:50 DEBUG : pacer: Reducing sleep to 273.402137ms 2026/07/07 02:35:50 DEBUG : pacer: Reducing sleep to 228.674937ms === RUN TestIntegration/FsMkdir/FsPutFiles/FsIsFile/FsRoot 2026/07/07 02:35:51 DEBUG : pacer: Reducing sleep to 119.675221ms === RUN TestIntegration/FsMkdir/FsPutFiles/FsIsFileNotFound 2026/07/07 02:35:51 DEBUG : Creating backend with remote "TestZoho:rclone-test-gicixob8wiza/not found.txt" 2026/07/07 02:35:51 DEBUG : pacer: Reducing sleep to 116.092223ms 2026/07/07 02:35:51 DEBUG : pacer: Reducing sleep to 153.016445ms 2026/07/07 02:35:53 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:35:53 DEBUG : pacer: Reducing sleep to 100.528373ms 2026/07/07 02:35:53 ERROR : error listing: directory not found === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot fstests.go:1920: Opening root remote "TestZoho:" path "rclone-test-gicixob8wiza" from "TestZoho:rclone-test-gicixob8wiza" 2026/07/07 02:35:53 DEBUG : Creating backend with remote "TestZoho:" === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot/List 2026/07/07 02:35:54 DEBUG : pacer: Reducing sleep to 104.095379ms 2026/07/07 02:35:54 DEBUG : pacer: Reducing sleep to 213.620766ms 2026/07/07 02:35:54 DEBUG : pacer: Reducing sleep to 277.128637ms 2026/07/07 02:35:54 DEBUG : pacer: Reducing sleep to 228.779571ms 2026/07/07 02:35:54 DEBUG : pacer: Reducing sleep to 118.103469ms === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot/ListEntries 2026/07/07 02:35:55 DEBUG : pacer: Reducing sleep to 54.389997ms === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot/ListR fstests.go:1957: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot/Put 2026/07/07 02:35:55 DEBUG : zoho root '': folder listing limiter sweep: evicted 7 of 13 idle limiters 2026/07/07 02:35:55 DEBUG : pacer: Reducing sleep to 108.115568ms 2026/07/07 02:35:55 DEBUG : pacer: Reducing sleep to 80.795289ms 2026/07/07 02:35:59 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:36:04 DEBUG : pacer: Reducing sleep to 110.967619ms 2026/07/07 02:36:04 DEBUG : pacer: Reducing sleep to 226.169882ms 2026/07/07 02:36:04 DEBUG : pacer: Reducing sleep to 277.464857ms 2026/07/07 02:36:04 DEBUG : pacer: Reducing sleep to 222.40835ms === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot/Put/Remove 2026/07/07 02:36:05 DEBUG : pacer: Reducing sleep to 73.58026ms 2026/07/07 02:36:08 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:36:08 DEBUG : pacer: Reducing sleep to 111.234173ms 2026/07/07 02:36:09 DEBUG : pacer: Reducing sleep to 227.627405ms 2026/07/07 02:36:09 DEBUG : pacer: Reducing sleep to 276.389601ms 2026/07/07 02:36:09 DEBUG : pacer: Reducing sleep to 216.715086ms === RUN TestIntegration/FsMkdir/FsPutFiles/PublicLink fstests.go:2016: FS has no PublicLinker interface === RUN TestIntegration/FsMkdir/FsPutFiles/SetTier fstests.go:412: FS has no SetTier & GetTier interfaces === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectCheckWrap fstests.go:2121: Not a wrapping Fs === RUN TestIntegration/FsMkdir/FsPutFiles/Bucket fstests.go:2137: Not a bucket based backend === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectRemove 2026/07/07 02:36:18 DEBUG : pacer: Reducing sleep to 104.084753ms 2026/07/07 02:36:18 DEBUG : pacer: Reducing sleep to 217.813348ms 2026/07/07 02:36:18 DEBUG : pacer: Reducing sleep to 273.778358ms 2026/07/07 02:36:18 DEBUG : pacer: Reducing sleep to 227.309367ms === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectAbout 2026/07/07 02:36:18 DEBUG : pacer: Reducing sleep to 112.299572ms === RUN TestIntegration/FsMkdir/FsPutFiles/FsPutStream fstests.go:2311: FS has no PutStream interface === RUN TestIntegration/FsMkdir/FsPutFiles/Internal fstests.go:2355: *zoho.Fs does not implement InternalTester === RUN TestIntegration/FsMkdir/FsPutChunked fstests.go:2376: *zoho.Fs does not implement SetUploadChunkSizer === RUN TestIntegration/FsMkdir/FsCopyChunked fstests.go:2497: *zoho.Fs does not implement SetCopyCutoff === RUN TestIntegration/FsMkdir/FsUploadUnknownSize === RUN TestIntegration/FsMkdir/FsUploadUnknownSize/FsPutUnknownSize 2026/07/07 02:36:22 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:36:22 DEBUG : pacer: Reducing sleep to 166.180052ms === RUN TestIntegration/FsMkdir/FsUploadUnknownSize/FsUpdateUnknownSize 2026/07/07 02:36:27 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:36:36 DEBUG : pacer: Reducing sleep to 166.323732ms === RUN TestIntegration/FsMkdir/FsRootCollapse 2026/07/07 02:36:36 DEBUG : Creating backend with remote "TestZoho:rclone-test-gicixob8wiza/deeper/nonexisting/directory" 2026/07/07 02:36:41 DEBUG : pacer: Reducing sleep to 30.271238ms 2026/07/07 02:36:45 DEBUG : pacer: Reducing sleep to 0s === RUN TestIntegration/FsMkdir/FsDirSetModTime fstests.go:2637: FS has no DirSetModTime interface === RUN TestIntegration/FsMkdir/FsMkdirMetadata fstests.go:2680: FS has no MkdirMetadata interface === RUN TestIntegration/FsMkdir/FsDirectory fstests.go:2737: FS has no Directory methods and doesn't Wrap 2026/07/07 02:36:50 DEBUG : pacer: Reducing sleep to 0s 2026/07/07 02:36:50 DEBUG : pacer: Reducing sleep to 107.456489ms 2026/07/07 02:36:50 DEBUG : pacer: Reducing sleep to 84.891228ms 2026/07/07 02:36:50 ERROR : error listing: directory not found 2026/07/07 02:36:50 DEBUG : pacer: Reducing sleep to 124.843189ms === RUN TestIntegration/FsShutdown fstests.go:2843: Shutdown method not supported --- PASS: TestIntegration (482.79s) --- SKIP: TestIntegration/FsCheckWrap (0.00s) --- SKIP: TestIntegration/FsCommand (0.00s) --- PASS: TestIntegration/FsRmdirNotFound (0.14s) --- PASS: TestIntegration/FsString (0.00s) --- PASS: TestIntegration/FsName (0.00s) --- PASS: TestIntegration/FsRoot (0.00s) --- PASS: TestIntegration/FsRmdirEmpty (0.21s) --- PASS: TestIntegration/FsMkdir (481.22s) --- PASS: TestIntegration/FsMkdir/FsMkdirRmdirSubdir (2.19s) --- PASS: TestIntegration/FsMkdir/FsListEmpty (0.23s) --- PASS: TestIntegration/FsMkdir/FsListDirEmpty (4.43s) --- SKIP: TestIntegration/FsMkdir/FsListRDirEmpty (0.00s) --- PASS: TestIntegration/FsMkdir/FsListDirNotFound (4.62s) --- SKIP: TestIntegration/FsMkdir/FsListRDirNotFound (0.00s) --- PASS: TestIntegration/FsMkdir/FsEncoding (195.35s) --- PASS: TestIntegration/FsMkdir/FsEncoding/control_chars (13.85s) --- PASS: TestIntegration/FsMkdir/FsEncoding/dot (13.86s) --- PASS: TestIntegration/FsMkdir/FsEncoding/dot_dot (13.83s) --- PASS: TestIntegration/FsMkdir/FsEncoding/punctuation (6.03s) --- PASS: TestIntegration/FsMkdir/FsEncoding/leading_space (1.98s) --- PASS: TestIntegration/FsMkdir/FsEncoding/leading_tilde (13.82s) --- PASS: TestIntegration/FsMkdir/FsEncoding/leading_CR (13.84s) --- PASS: TestIntegration/FsMkdir/FsEncoding/leading_LF (13.85s) --- PASS: TestIntegration/FsMkdir/FsEncoding/leading_HT (13.85s) --- PASS: TestIntegration/FsMkdir/FsEncoding/leading_VT (2.34s) --- PASS: TestIntegration/FsMkdir/FsEncoding/leading_dot (5.93s) --- PASS: TestIntegration/FsMkdir/FsEncoding/trailing_space (13.85s) --- PASS: TestIntegration/FsMkdir/FsEncoding/trailing_CR (13.85s) --- PASS: TestIntegration/FsMkdir/FsEncoding/trailing_LF (13.84s) --- PASS: TestIntegration/FsMkdir/FsEncoding/trailing_HT (9.83s) --- PASS: TestIntegration/FsMkdir/FsEncoding/trailing_VT (2.61s) --- PASS: TestIntegration/FsMkdir/FsEncoding/trailing_dot (9.73s) --- SKIP: TestIntegration/FsMkdir/FsEncoding/invalid_UTF-8 (0.00s) --- PASS: TestIntegration/FsMkdir/FsEncoding/URL_encoding (13.85s) --- PASS: TestIntegration/FsMkdir/FsNewObjectNotFound (9.23s) --- PASS: TestIntegration/FsMkdir/FsPutError (10.47s) --- PASS: TestIntegration/FsMkdir/FsPutZeroLength (8.47s) --- SKIP: TestIntegration/FsMkdir/FsOpenWriterAt (0.00s) --- SKIP: TestIntegration/FsMkdir/FsOpenChunkWriter (0.00s) --- SKIP: TestIntegration/FsMkdir/FsChangeNotify (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles (213.56s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListDirFile2 (0.78s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FsListRDirFile2 (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListR (0.82s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListRSubdir (0.81s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListDirRoot (0.35s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FsListRDirRoot (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListSubdir (8.78s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FsListRSubdir#01 (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListLevel2 (0.11s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FsListRLevel2 (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListFile1 (5.02s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsNewObject (4.16s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FsNewObjectCaseInsensitive (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListFile1and2 (5.06s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsNewObjectDir (4.34s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsPurge (14.36s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsPurgeRoot (15.60s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListRootedSubdir (3.80s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsCopy (3.67s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FsCopy/Metadata (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsMove (33.34s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FsMove/Metadata (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsDirMove (9.01s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsRmdirFull (0.06s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsPrecision (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectString (3.73s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectFs (4.62s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectRemote (0.05s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectHashes (0.06s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectModTime (0.11s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/ObjectMimeType (0.23s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/ObjectMetadata (1.15s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/ObjectSetMetadata (4.62s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectSetModTime (4.63s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectSize (4.60s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectOpen (4.83s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectOpenSeek (4.73s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectOpenRange (5.11s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectPartialRead (4.13s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectUpdate (9.06s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectStorable (4.44s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsIsFile (9.94s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsIsFile/FsRoot (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsIsFileNotFound (2.86s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FromRoot (15.50s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FromRoot/List (0.92s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FromRoot/ListEntries (0.23s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FromRoot/ListR (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FromRoot/Put (14.35s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FromRoot/Put/Remove (4.62s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/PublicLink (0.00s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/SetTier (0.00s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/ObjectCheckWrap (0.00s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/Bucket (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectRemove (9.22s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectAbout (0.28s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FsPutStream (0.00s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/Internal (0.00s) --- SKIP: TestIntegration/FsMkdir/FsPutChunked (0.00s) --- SKIP: TestIntegration/FsMkdir/FsCopyChunked (0.00s) --- PASS: TestIntegration/FsMkdir/FsUploadUnknownSize (17.74s) --- PASS: TestIntegration/FsMkdir/FsUploadUnknownSize/FsPutUnknownSize (3.90s) --- PASS: TestIntegration/FsMkdir/FsUploadUnknownSize/FsUpdateUnknownSize (13.84s) --- PASS: TestIntegration/FsMkdir/FsRootCollapse (13.84s) --- SKIP: TestIntegration/FsMkdir/FsDirSetModTime (0.00s) --- SKIP: TestIntegration/FsMkdir/FsMkdirMetadata (0.00s) --- SKIP: TestIntegration/FsMkdir/FsDirectory (0.00s) --- SKIP: TestIntegration/FsShutdown (0.00s) PASS ok github.com/rclone/rclone/backend/zoho 482.803s "go test -v -timeout 2h0m0s -remote TestZoho: -verbose" - Finished OK in 8m3.536167378s (try 1/5)