"go test -v -timeout 1h0m0s -remote TestPikPak: -verbose -test.run '^TestIntegration$/^FsMkdir$/^FsEncoding$/^(URL_encoding|dot|dot_dot|invalid_UTF-8|leading_CR|leading_HT|leading_LF|leading_VT|leading_dot|leading_space|leading_tilde|punctuation|trailing_CR|trailing_HT|trailing_LF|trailing_VT|trailing_dot|trailing_space)$|^TestIntegration$/^FsMkdir$/^FsPutFiles$'" - Starting (try 3/5) === RUN TestIntegration fstests.go:438: Using remote "TestPikPak:" 2026/05/10 03:00:50 DEBUG : Creating backend with remote "TestPikPak:rclone-test-zotigaz2hepo" 2026/05/10 03:00:50 DEBUG : Using config file from "/home/rclone/.rclone.conf" === RUN TestIntegration/FsMkdir === RUN TestIntegration/FsMkdir/FsEncoding === RUN TestIntegration/FsMkdir/FsEncoding/dot fstests.go:708: testing "." 2026/05/10 03:00:54 DEBUG : ./.: calculating gcid: failed to unwrap object from src: ./. 2026/05/10 03:00:54 DEBUG : ./.: gcid = 7b2a513859df34d5aa2239f7f3e3c00f7c7ca49e 2026/05/10 03:00:57 DEBUG : pacer: low level retry 1/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:00:57 DEBUG : pacer: Rate limited, increasing sleep to 200ms 2026/05/10 03:00:57 DEBUG : pacer: low level retry 2/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:00:57 DEBUG : pacer: Rate limited, increasing sleep to 400ms 2026/05/10 03:00:57 DEBUG : pacer: low level retry 3/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:00:57 DEBUG : pacer: Rate limited, increasing sleep to 800ms 2026/05/10 03:00:58 DEBUG : pacer: low level retry 4/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:00:58 DEBUG : pacer: Rate limited, increasing sleep to 1.6s 2026/05/10 03:00:58 DEBUG : pacer: low level retry 5/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:00:58 DEBUG : pacer: Rate limited, increasing sleep to 2s 2026/05/10 03:01:00 DEBUG : pacer: low level retry 6/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:01:02 DEBUG : pacer: low level retry 7/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:01:04 DEBUG : pacer: low level retry 8/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:01:06 DEBUG : pacer: low level retry 9/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:01:08 DEBUG : pacer: Reducing sleep to 1.5s 2026/05/10 03:01:10 DEBUG : pacer: Reducing sleep to 1.125s 2026/05/10 03:01:12 DEBUG : pacer: Reducing sleep to 843.75ms 2026/05/10 03:01:13 DEBUG : pacer: Reducing sleep to 632.8125ms 2026/05/10 03:01:13 DEBUG : pacer: Reducing sleep to 474.609375ms 2026/05/10 03:01:14 DEBUG : pacer: Reducing sleep to 355.957031ms 2026/05/10 03:01:15 DEBUG : pacer: Reducing sleep to 266.967773ms 2026/05/10 03:01:15 DEBUG : .: Rmdir: contains trashed file: "." 2026/05/10 03:01:15 DEBUG : pacer: Reducing sleep to 200.225829ms 2026/05/10 03:01:16 DEBUG : pacer: Reducing sleep to 150.169371ms 2026/05/10 03:01:16 DEBUG : pacer: Reducing sleep to 112.627028ms === RUN TestIntegration/FsMkdir/FsEncoding/dot_dot fstests.go:708: testing ".." 2026/05/10 03:01:16 DEBUG : pacer: Reducing sleep to 100ms 2026/05/10 03:01:17 DEBUG : ../..: calculating gcid: failed to unwrap object from src: ../.. 2026/05/10 03:01:17 DEBUG : ../..: gcid = 05f0b388b81ed8baf7b046ec1dfb4a156ef23cbd 2026/05/10 03:01:19 DEBUG : pacer: low level retry 1/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:01:19 DEBUG : pacer: Rate limited, increasing sleep to 200ms 2026/05/10 03:01:20 DEBUG : pacer: low level retry 2/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:01:20 DEBUG : pacer: Rate limited, increasing sleep to 400ms 2026/05/10 03:01:20 DEBUG : pacer: low level retry 3/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:01:20 DEBUG : pacer: Rate limited, increasing sleep to 800ms 2026/05/10 03:01:20 DEBUG : pacer: low level retry 4/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:01:20 DEBUG : pacer: Rate limited, increasing sleep to 1.6s 2026/05/10 03:01:21 DEBUG : pacer: low level retry 5/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:01:21 DEBUG : pacer: Rate limited, increasing sleep to 2s 2026/05/10 03:01:23 DEBUG : pacer: low level retry 6/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:01:25 DEBUG : pacer: low level retry 7/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:01:27 DEBUG : pacer: low level retry 8/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:01:29 DEBUG : pacer: low level retry 9/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:01:31 DEBUG : pacer: low level retry 10/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:01:31 DEBUG : ..: canceling upload: can't verify the task is completed: &api.Task{Kind:"drive#task", ID:"VOsEpEvUqW4r6n2NPGHFics1o2", Name:"upload", Type:"upload", UserID:"ZB7KFqZKGnYUJW_K", Statuses:[]interface {}{}, StatusSize:0, Params:(*api.TaskParams)(0x33bfa5b50000), FileID:"VOsEpEvBqW4r6n2NPGHFics-o2", FileName:"..", FileSize:"100", Message:"Pending", CreatedTime:api.Time{wall:0x278493c0, ext:63913978877, loc:(*time.Location)(0x33bfa5a7f340)}, UpdatedTime:api.Time{wall:0x28d44540, ext:63913978877, loc:(*time.Location)(0x33bfa5a7f340)}, ThirdTaskID:"", Phase:"PHASE_TYPE_PENDING", Progress:0, IconLink:"https://static.mypikpak.com/0ed033dfc7b3862af92a52ef7e3e4d257223df81", Callback:"", ReferenceResource:interface {}(nil), Space:""} 2026/05/10 03:01:33 DEBUG : pacer: Reducing sleep to 1.5s 2026/05/10 03:01:35 DEBUG : pacer: Reducing sleep to 1.125s 2026/05/10 03:01:36 DEBUG : pacer: Reducing sleep to 843.75ms 2026/05/10 03:01:36 DEBUG : ..: waiting 500ms for the cancellation to be effective fstests.go:146: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:146 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:162 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:224 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:214 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:714 /usr/local/go/src/runtime/asm_amd64.s:1771 Error: Received unexpected error: can't verify the task is completed: &api.Task{Kind:"drive#task", ID:"VOsEpEvUqW4r6n2NPGHFics1o2", Name:"upload", Type:"upload", UserID:"ZB7KFqZKGnYUJW_K", Statuses:[]interface {}{}, StatusSize:0, Params:(*api.TaskParams)(0x33bfa5b50000), FileID:"VOsEpEvBqW4r6n2NPGHFics-o2", FileName:"..", FileSize:"100", Message:"Pending", CreatedTime:api.Time{wall:0x278493c0, ext:63913978877, loc:(*time.Location)(0x33bfa5a7f340)}, UpdatedTime:api.Time{wall:0x28d44540, ext:63913978877, loc:(*time.Location)(0x33bfa5a7f340)}, ThirdTaskID:"", Phase:"PHASE_TYPE_PENDING", Progress:0, IconLink:"https://static.mypikpak.com/0ed033dfc7b3862af92a52ef7e3e4d257223df81", Callback:"", ReferenceResource:interface {}(nil), Space:""} Test: TestIntegration/FsMkdir/FsEncoding/dot_dot Messages: Put === RUN TestIntegration/FsMkdir/FsEncoding/punctuation fstests.go:708: testing "!\"#$%&'()*+,-./:;<=>?@[\\]^_`{|}~" 2026/05/10 03:01:37 DEBUG : pacer: Reducing sleep to 632.8125ms 2026/05/10 03:01:38 DEBUG : pacer: Reducing sleep to 474.609375ms 2026/05/10 03:01:40 DEBUG : Saving config "captcha_token" in section "TestPikPak" of the config file 2026/05/10 03:01:40 DEBUG : pacer: Reducing sleep to 355.957031ms 2026/05/10 03:01:40 DEBUG : !"#$%&'()*+,-./:;<=>?@[\]^_`{|}~/!"#$%&'()*+,-./:;<=>?@[\]^_`{|}~: calculating gcid: failed to unwrap object from src: !"#$%&'()*+,-./:;<=>?@[\]^_`{|}~/!"#$%&'()*+,-./:;<=>?@[\]^_`{|}~ 2026/05/10 03:01:40 DEBUG : !"#$%&'()*+,-./:;<=>?@[\]^_`{|}~/!"#$%&'()*+,-./:;<=>?@[\]^_`{|}~: gcid = f190b5ed938a69626a702e96f893bd7fdb8e013a 2026/05/10 03:01:40 DEBUG : pacer: Reducing sleep to 266.967773ms 2026/05/10 03:01:42 DEBUG : pacer: Reducing sleep to 200.225829ms 2026/05/10 03:01:42 DEBUG : pacer: low level retry 1/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:01:42 DEBUG : pacer: Rate limited, increasing sleep to 400.451658ms 2026/05/10 03:01:43 DEBUG : pacer: low level retry 2/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:01:43 DEBUG : pacer: Rate limited, increasing sleep to 800.903316ms 2026/05/10 03:01:43 DEBUG : pacer: low level retry 3/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:01:43 DEBUG : pacer: Rate limited, increasing sleep to 1.601806632s 2026/05/10 03:01:44 DEBUG : pacer: low level retry 4/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:01:44 DEBUG : pacer: Rate limited, increasing sleep to 2s 2026/05/10 03:01:45 DEBUG : pacer: low level retry 5/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:01:47 DEBUG : pacer: low level retry 6/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:01:49 DEBUG : pacer: low level retry 7/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:01:51 DEBUG : pacer: low level retry 8/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:01:53 DEBUG : pacer: low level retry 9/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:01:55 DEBUG : pacer: low level retry 10/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:01:55 DEBUG : !"#$%&'()*+,-./:;<=>?@[\]^_`{|}~: canceling upload: can't verify the task is completed: &api.Task{Kind:"drive#task", ID:"VOsEpKWLcn7Ku0VP0fjc4s2Do2", Name:"upload", Type:"upload", UserID:"ZB7KFqZKGnYUJW_K", Statuses:[]interface {}{}, StatusSize:0, Params:(*api.TaskParams)(0x33bfa5b51480), FileID:"VOsEpKVxcn7Ku0VP0fjc4s26o2", FileName:"!"#$%&'()*+,-./:;<=>?@[\]^_`{|}~", FileSize:"100", Message:"Pending", CreatedTime:api.Time{wall:0x21bc7980, ext:63913978900, loc:(*time.Location)(0x33bfa5a7f340)}, UpdatedTime:api.Time{wall:0x22fce8c0, ext:63913978900, loc:(*time.Location)(0x33bfa5a7f340)}, ThirdTaskID:"", Phase:"PHASE_TYPE_PENDING", Progress:0, IconLink:"https://static.mypikpak.com/0ed033dfc7b3862af92a52ef7e3e4d257223df81", Callback:"", ReferenceResource:interface {}(nil), Space:""} 2026/05/10 03:01:57 DEBUG : pacer: Reducing sleep to 1.5s 2026/05/10 03:01:59 DEBUG : pacer: Reducing sleep to 1.125s 2026/05/10 03:02:01 DEBUG : pacer: Reducing sleep to 843.75ms 2026/05/10 03:02:01 DEBUG : !"#$%&'()*+,-./:;<=>?@[\]^_`{|}~: waiting 500ms for the cancellation to be effective fstests.go:146: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:146 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:162 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:224 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:214 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:714 /usr/local/go/src/runtime/asm_amd64.s:1771 Error: Received unexpected error: can't verify the task is completed: &api.Task{Kind:"drive#task", ID:"VOsEpKWLcn7Ku0VP0fjc4s2Do2", Name:"upload", Type:"upload", UserID:"ZB7KFqZKGnYUJW_K", Statuses:[]interface {}{}, StatusSize:0, Params:(*api.TaskParams)(0x33bfa5b51480), FileID:"VOsEpKVxcn7Ku0VP0fjc4s26o2", FileName:"!"#$%&'()*+,-./:;<=>?@[\]^_`{|}~", FileSize:"100", Message:"Pending", CreatedTime:api.Time{wall:0x21bc7980, ext:63913978900, loc:(*time.Location)(0x33bfa5a7f340)}, UpdatedTime:api.Time{wall:0x22fce8c0, ext:63913978900, loc:(*time.Location)(0x33bfa5a7f340)}, ThirdTaskID:"", Phase:"PHASE_TYPE_PENDING", Progress:0, IconLink:"https://static.mypikpak.com/0ed033dfc7b3862af92a52ef7e3e4d257223df81", Callback:"", ReferenceResource:interface {}(nil), Space:""} Test: TestIntegration/FsMkdir/FsEncoding/punctuation Messages: Put === RUN TestIntegration/FsMkdir/FsEncoding/leading_space fstests.go:708: testing " leading space" 2026/05/10 03:02:02 DEBUG : pacer: Reducing sleep to 632.8125ms 2026/05/10 03:02:03 DEBUG : pacer: Reducing sleep to 474.609375ms 2026/05/10 03:02:04 DEBUG : pacer: Reducing sleep to 355.957031ms 2026/05/10 03:02:04 DEBUG : leading space/ leading space: calculating gcid: failed to unwrap object from src: leading space/ leading space 2026/05/10 03:02:04 DEBUG : leading space/ leading space: gcid = 4e70a82061ad1e807184cc5ceb11c9b698501b88 2026/05/10 03:02:04 DEBUG : pacer: Reducing sleep to 266.967773ms 2026/05/10 03:02:05 DEBUG : pacer: Reducing sleep to 200.225829ms 2026/05/10 03:02:06 DEBUG : pacer: low level retry 1/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:02:06 DEBUG : pacer: Rate limited, increasing sleep to 400.451658ms 2026/05/10 03:02:06 DEBUG : pacer: low level retry 2/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:02:06 DEBUG : pacer: Rate limited, increasing sleep to 800.903316ms 2026/05/10 03:02:07 DEBUG : pacer: low level retry 3/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:02:07 DEBUG : pacer: Rate limited, increasing sleep to 1.601806632s 2026/05/10 03:02:07 DEBUG : pacer: low level retry 4/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:02:07 DEBUG : pacer: Rate limited, increasing sleep to 2s 2026/05/10 03:02:09 DEBUG : pacer: Reducing sleep to 1.5s 2026/05/10 03:02:11 DEBUG : pacer: Reducing sleep to 1.125s 2026/05/10 03:02:13 DEBUG : pacer: Reducing sleep to 843.75ms 2026/05/10 03:02:14 DEBUG : pacer: Reducing sleep to 632.8125ms 2026/05/10 03:02:15 DEBUG : pacer: Reducing sleep to 474.609375ms 2026/05/10 03:02:15 DEBUG : pacer: Reducing sleep to 355.957031ms fstest.go:298: Sleeping for 1s for list eventual consistency: 1/3 fstest.go:301: Flushing the directory cache 2026/05/10 03:02:16 DEBUG : pacer: Reducing sleep to 266.967773ms 2026/05/10 03:02:17 DEBUG : pacer: Reducing sleep to 200.225829ms 2026/05/10 03:02:17 DEBUG : pacer: Reducing sleep to 150.169371ms 2026/05/10 03:02:17 DEBUG : pacer: Reducing sleep to 112.627028ms 2026/05/10 03:02:18 DEBUG : pacer: Reducing sleep to 100ms fstest.go:298: Sleeping for 2s for list eventual consistency: 2/3 fstest.go:301: Flushing the directory cache fstest.go:298: Sleeping for 4s for list eventual consistency: 3/3 fstest.go:301: Flushing the directory cache fstest.go:327: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:327 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:338 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:715 Error: Not equal: expected: []string{" leading space"} actual : []string{" leading space", "!\"#$%&'()*+,-./:;<=>?@[\\]^_`{|}~", ".."} Diff: --- Expected +++ Actual @@ -1,3 +1,5 @@ -([]string) (len=1) { - (string) (len=14) " leading space" +([]string) (len=3) { + (string) (len=14) " leading space", + (string) (len=34) "!\"#$%&'()*+,-./:;<=>?@[\\]^_`{|}~", + (string) (len=6) ".." } Test: TestIntegration/FsMkdir/FsEncoding/leading_space Messages: directories 2026/05/10 03:02:27 DEBUG : leading space: Rmdir: contains trashed file: " leading space" fstest.go:298: Sleeping for 1s for list eventual consistency: 1/3 fstest.go:301: Flushing the directory cache fstest.go:298: Sleeping for 2s for list eventual consistency: 2/3 fstest.go:301: Flushing the directory cache fstest.go:298: Sleeping for 4s for list eventual consistency: 3/3 fstest.go:301: Flushing the directory cache fstest.go:327: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:327 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:338 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:718 Error: Not equal: expected: []string{} actual : []string{"!\"#$%&'()*+,-./:;<=>?@[\\]^_`{|}~", ".."} Diff: --- Expected +++ Actual @@ -1,2 +1,4 @@ -([]string) { +([]string) (len=2) { + (string) (len=34) "!\"#$%&'()*+,-./:;<=>?@[\\]^_`{|}~", + (string) (len=6) ".." } Test: TestIntegration/FsMkdir/FsEncoding/leading_space Messages: directories === RUN TestIntegration/FsMkdir/FsEncoding/leading_tilde fstests.go:708: testing "~leading tilde" 2026/05/10 03:02:38 DEBUG : ~leading tilde/~leading tilde: calculating gcid: failed to unwrap object from src: ~leading tilde/~leading tilde 2026/05/10 03:02:38 DEBUG : ~leading tilde/~leading tilde: gcid = 2dd0070cf38cf4d2ef1825e526194dab8c94473d 2026/05/10 03:02:41 DEBUG : pacer: low level retry 1/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:02:41 DEBUG : pacer: Rate limited, increasing sleep to 200ms 2026/05/10 03:02:41 DEBUG : pacer: low level retry 2/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:02:41 DEBUG : pacer: Rate limited, increasing sleep to 400ms 2026/05/10 03:02:41 DEBUG : pacer: low level retry 3/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:02:41 DEBUG : pacer: Rate limited, increasing sleep to 800ms 2026/05/10 03:02:42 DEBUG : pacer: low level retry 4/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:02:42 DEBUG : pacer: Rate limited, increasing sleep to 1.6s 2026/05/10 03:02:43 DEBUG : pacer: low level retry 5/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:02:43 DEBUG : pacer: Rate limited, increasing sleep to 2s 2026/05/10 03:02:44 DEBUG : pacer: low level retry 6/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:02:46 DEBUG : pacer: low level retry 7/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:02:48 DEBUG : pacer: low level retry 8/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:02:50 DEBUG : pacer: low level retry 9/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:02:52 DEBUG : pacer: low level retry 10/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:02:52 DEBUG : ~leading tilde: canceling upload: can't verify the task is completed: &api.Task{Kind:"drive#task", ID:"VOsEpYoIlYLADoMYgilGHbcno2", Name:"upload", Type:"upload", UserID:"ZB7KFqZKGnYUJW_K", Statuses:[]interface {}{}, StatusSize:0, Params:(*api.TaskParams)(0x33bfa5c42a40), FileID:"VOsEpYnolYLADoMYgilGHbclo2", FileName:"~leading tilde", FileSize:"100", Message:"Pending", CreatedTime:api.Time{wall:0x754d4c0, ext:63913978959, loc:(*time.Location)(0x33bfa5a7f340)}, UpdatedTime:api.Time{wall:0xa5f0780, ext:63913978959, loc:(*time.Location)(0x33bfa5a7f340)}, ThirdTaskID:"", Phase:"PHASE_TYPE_PENDING", Progress:0, IconLink:"https://static.mypikpak.com/0ed033dfc7b3862af92a52ef7e3e4d257223df81", Callback:"", ReferenceResource:interface {}(nil), Space:""} 2026/05/10 03:02:54 DEBUG : pacer: Reducing sleep to 1.5s 2026/05/10 03:02:56 DEBUG : pacer: Reducing sleep to 1.125s 2026/05/10 03:02:58 DEBUG : pacer: Reducing sleep to 843.75ms 2026/05/10 03:02:58 DEBUG : ~leading tilde: waiting 500ms for the cancellation to be effective fstests.go:146: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:146 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:162 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:224 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:214 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:714 /usr/local/go/src/runtime/asm_amd64.s:1771 Error: Received unexpected error: can't verify the task is completed: &api.Task{Kind:"drive#task", ID:"VOsEpYoIlYLADoMYgilGHbcno2", Name:"upload", Type:"upload", UserID:"ZB7KFqZKGnYUJW_K", Statuses:[]interface {}{}, StatusSize:0, Params:(*api.TaskParams)(0x33bfa5c42a40), FileID:"VOsEpYnolYLADoMYgilGHbclo2", FileName:"~leading tilde", FileSize:"100", Message:"Pending", CreatedTime:api.Time{wall:0x754d4c0, ext:63913978959, loc:(*time.Location)(0x33bfa5a7f340)}, UpdatedTime:api.Time{wall:0xa5f0780, ext:63913978959, loc:(*time.Location)(0x33bfa5a7f340)}, ThirdTaskID:"", Phase:"PHASE_TYPE_PENDING", Progress:0, IconLink:"https://static.mypikpak.com/0ed033dfc7b3862af92a52ef7e3e4d257223df81", Callback:"", ReferenceResource:interface {}(nil), Space:""} Test: TestIntegration/FsMkdir/FsEncoding/leading_tilde Messages: Put === RUN TestIntegration/FsMkdir/FsEncoding/leading_CR fstests.go:708: testing "␍leading CR" 2026/05/10 03:02:59 DEBUG : pacer: Reducing sleep to 632.8125ms 2026/05/10 03:03:00 DEBUG : pacer: Reducing sleep to 474.609375ms 2026/05/10 03:03:00 DEBUG : pacer: Reducing sleep to 355.957031ms 2026/05/10 03:03:00 DEBUG : ␍leading CR/␍leading CR: calculating gcid: failed to unwrap object from src: ␍leading CR/␍leading CR 2026/05/10 03:03:00 DEBUG : ␍leading CR/␍leading CR: gcid = ab97d770af75df86f52709bf76d525c9557cf05f 2026/05/10 03:03:01 DEBUG : pacer: Reducing sleep to 266.967773ms 2026/05/10 03:03:02 DEBUG : pacer: Reducing sleep to 200.225829ms 2026/05/10 03:03:03 DEBUG : pacer: low level retry 1/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:03:03 DEBUG : pacer: Rate limited, increasing sleep to 400.451658ms 2026/05/10 03:03:03 DEBUG : pacer: low level retry 2/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:03:03 DEBUG : pacer: Rate limited, increasing sleep to 800.903316ms 2026/05/10 03:03:04 DEBUG : pacer: low level retry 3/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:03:04 DEBUG : pacer: Rate limited, increasing sleep to 1.601806632s 2026/05/10 03:03:04 DEBUG : pacer: low level retry 4/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:03:04 DEBUG : pacer: Rate limited, increasing sleep to 2s 2026/05/10 03:03:06 DEBUG : pacer: low level retry 5/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:03:08 DEBUG : pacer: low level retry 6/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:03:10 DEBUG : pacer: low level retry 7/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:03:12 DEBUG : pacer: low level retry 8/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:03:14 DEBUG : pacer: low level retry 9/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:03:16 DEBUG : pacer: low level retry 10/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:03:16 DEBUG : ␍leading CR: canceling upload: can't verify the task is completed: &api.Task{Kind:"drive#task", ID:"VOsEpdCVLSahb5zuLhSgEbHPo2", Name:"upload", Type:"upload", UserID:"ZB7KFqZKGnYUJW_K", Statuses:[]interface {}{}, StatusSize:0, Params:(*api.TaskParams)(0x33bfa5c42380), FileID:"VOsEpdC7LSahb5zuLhSgEbHLo2", FileName:"␍leading CR", FileSize:"100", Message:"Pending", CreatedTime:api.Time{wall:0xcdfe600, ext:63913978981, loc:(*time.Location)(0x33bfa5a7f340)}, UpdatedTime:api.Time{wall:0xe5d5e40, ext:63913978981, loc:(*time.Location)(0x33bfa5a7f340)}, ThirdTaskID:"", Phase:"PHASE_TYPE_PENDING", Progress:0, IconLink:"https://static.mypikpak.com/0ed033dfc7b3862af92a52ef7e3e4d257223df81", Callback:"", ReferenceResource:interface {}(nil), Space:""} 2026/05/10 03:03:18 DEBUG : pacer: Reducing sleep to 1.5s 2026/05/10 03:03:20 DEBUG : pacer: Reducing sleep to 1.125s 2026/05/10 03:03:22 DEBUG : pacer: Reducing sleep to 843.75ms 2026/05/10 03:03:22 DEBUG : ␍leading CR: waiting 500ms for the cancellation to be effective fstests.go:146: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:146 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:162 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:224 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:214 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:714 /usr/local/go/src/runtime/asm_amd64.s:1771 Error: Received unexpected error: can't verify the task is completed: &api.Task{Kind:"drive#task", ID:"VOsEpdCVLSahb5zuLhSgEbHPo2", Name:"upload", Type:"upload", UserID:"ZB7KFqZKGnYUJW_K", Statuses:[]interface {}{}, StatusSize:0, Params:(*api.TaskParams)(0x33bfa5c42380), FileID:"VOsEpdC7LSahb5zuLhSgEbHLo2", FileName:"␍leading CR", FileSize:"100", Message:"Pending", CreatedTime:api.Time{wall:0xcdfe600, ext:63913978981, loc:(*time.Location)(0x33bfa5a7f340)}, UpdatedTime:api.Time{wall:0xe5d5e40, ext:63913978981, loc:(*time.Location)(0x33bfa5a7f340)}, ThirdTaskID:"", Phase:"PHASE_TYPE_PENDING", Progress:0, IconLink:"https://static.mypikpak.com/0ed033dfc7b3862af92a52ef7e3e4d257223df81", Callback:"", ReferenceResource:interface {}(nil), Space:""} Test: TestIntegration/FsMkdir/FsEncoding/leading_CR Messages: Put === RUN TestIntegration/FsMkdir/FsEncoding/leading_LF fstests.go:708: testing "␊leading LF" 2026/05/10 03:03:23 DEBUG : pacer: Reducing sleep to 632.8125ms 2026/05/10 03:03:24 DEBUG : pacer: Reducing sleep to 474.609375ms 2026/05/10 03:03:24 DEBUG : pacer: Reducing sleep to 355.957031ms 2026/05/10 03:03:24 DEBUG : ␊leading LF/␊leading LF: calculating gcid: failed to unwrap object from src: ␊leading LF/␊leading LF 2026/05/10 03:03:24 DEBUG : ␊leading LF/␊leading LF: gcid = fe693baffc109d0cb4bcc03d74304d61c9616d5e 2026/05/10 03:03:25 DEBUG : pacer: Reducing sleep to 266.967773ms 2026/05/10 03:03:26 DEBUG : pacer: Reducing sleep to 200.225829ms 2026/05/10 03:03:27 DEBUG : pacer: low level retry 1/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:03:27 DEBUG : pacer: Rate limited, increasing sleep to 400.451658ms 2026/05/10 03:03:27 DEBUG : pacer: low level retry 2/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:03:27 DEBUG : pacer: Rate limited, increasing sleep to 800.903316ms 2026/05/10 03:03:27 DEBUG : pacer: low level retry 3/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:03:27 DEBUG : pacer: Rate limited, increasing sleep to 1.601806632s 2026/05/10 03:03:28 DEBUG : pacer: low level retry 4/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:03:28 DEBUG : pacer: Rate limited, increasing sleep to 2s 2026/05/10 03:03:30 DEBUG : pacer: low level retry 5/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:03:32 DEBUG : pacer: low level retry 6/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:03:34 DEBUG : pacer: Reducing sleep to 1.5s 2026/05/10 03:03:36 DEBUG : pacer: Reducing sleep to 1.125s 2026/05/10 03:03:37 DEBUG : pacer: Reducing sleep to 843.75ms 2026/05/10 03:03:38 DEBUG : pacer: Reducing sleep to 632.8125ms 2026/05/10 03:03:39 DEBUG : pacer: Reducing sleep to 474.609375ms 2026/05/10 03:03:40 DEBUG : pacer: Reducing sleep to 355.957031ms 2026/05/10 03:03:40 DEBUG : pacer: Reducing sleep to 266.967773ms 2026/05/10 03:03:41 DEBUG : pacer: Reducing sleep to 200.225829ms fstest.go:298: Sleeping for 1s for list eventual consistency: 1/3 fstest.go:301: Flushing the directory cache 2026/05/10 03:03:42 DEBUG : pacer: Reducing sleep to 150.169371ms 2026/05/10 03:03:42 DEBUG : pacer: Reducing sleep to 112.627028ms 2026/05/10 03:03:43 DEBUG : pacer: Reducing sleep to 100ms fstest.go:298: Sleeping for 2s for list eventual consistency: 2/3 fstest.go:301: Flushing the directory cache fstest.go:298: Sleeping for 4s for list eventual consistency: 3/3 fstest.go:301: Flushing the directory cache fstest.go:327: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:327 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:338 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:715 Error: Not equal: expected: []string{"␊leading LF"} actual : []string{"!\"#$%&'()*+,-./:;<=>?@[\\]^_`{|}~", "~leading tilde", "␊leading LF", "␍leading CR", ".."} Diff: --- Expected +++ Actual @@ -1,3 +1,7 @@ -([]string) (len=1) { - (string) (len=13) "␊leading LF" +([]string) (len=5) { + (string) (len=34) "!\"#$%&'()*+,-./:;<=>?@[\\]^_`{|}~", + (string) (len=14) "~leading tilde", + (string) (len=13) "␊leading LF", + (string) (len=13) "␍leading CR", + (string) (len=6) ".." } Test: TestIntegration/FsMkdir/FsEncoding/leading_LF Messages: directories 2026/05/10 03:03:52 DEBUG : ␊leading LF: Rmdir: contains trashed file: "␊leading LF" fstest.go:298: Sleeping for 1s for list eventual consistency: 1/3 fstest.go:301: Flushing the directory cache fstest.go:298: Sleeping for 2s for list eventual consistency: 2/3 fstest.go:301: Flushing the directory cache fstest.go:298: Sleeping for 4s for list eventual consistency: 3/3 fstest.go:301: Flushing the directory cache fstest.go:327: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:327 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:338 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:718 Error: Not equal: expected: []string{} actual : []string{"!\"#$%&'()*+,-./:;<=>?@[\\]^_`{|}~", "~leading tilde", "␍leading CR", ".."} Diff: --- Expected +++ Actual @@ -1,2 +1,6 @@ -([]string) { +([]string) (len=4) { + (string) (len=34) "!\"#$%&'()*+,-./:;<=>?@[\\]^_`{|}~", + (string) (len=14) "~leading tilde", + (string) (len=13) "␍leading CR", + (string) (len=6) ".." } Test: TestIntegration/FsMkdir/FsEncoding/leading_LF Messages: directories === RUN TestIntegration/FsMkdir/FsEncoding/leading_HT fstests.go:708: testing "␉leading HT" 2026/05/10 03:04:05 DEBUG : ␉leading HT/␉leading HT: calculating gcid: failed to unwrap object from src: ␉leading HT/␉leading HT 2026/05/10 03:04:05 DEBUG : ␉leading HT/␉leading HT: gcid = 73afba59be9180b43f28304c2d5b84bbcaa69fbd 2026/05/10 03:04:07 DEBUG : pacer: low level retry 1/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:04:07 DEBUG : pacer: Rate limited, increasing sleep to 200ms 2026/05/10 03:04:07 DEBUG : pacer: low level retry 2/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:04:07 DEBUG : pacer: Rate limited, increasing sleep to 400ms 2026/05/10 03:04:08 DEBUG : pacer: low level retry 3/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:04:08 DEBUG : pacer: Rate limited, increasing sleep to 800ms 2026/05/10 03:04:08 DEBUG : pacer: low level retry 4/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:04:08 DEBUG : pacer: Rate limited, increasing sleep to 1.6s 2026/05/10 03:04:09 DEBUG : pacer: low level retry 5/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:04:09 DEBUG : pacer: Rate limited, increasing sleep to 2s 2026/05/10 03:04:10 DEBUG : pacer: low level retry 6/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:04:12 DEBUG : pacer: low level retry 7/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:04:14 DEBUG : pacer: low level retry 8/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:04:16 DEBUG : pacer: low level retry 9/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:04:18 DEBUG : pacer: low level retry 10/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:04:18 DEBUG : ␉leading HT: canceling upload: can't verify the task is completed: &api.Task{Kind:"drive#task", ID:"VOsEpsqZcn7Ku0VP0fjc4xcZo2", Name:"upload", Type:"upload", UserID:"ZB7KFqZKGnYUJW_K", Statuses:[]interface {}{}, StatusSize:0, Params:(*api.TaskParams)(0x33bfa5f60600), FileID:"VOsEpsqEcn7Ku0VP0fjc4xcWo2", FileName:"␉leading HT", FileSize:"100", Message:"Pending", CreatedTime:api.Time{wall:0x10ed7f00, ext:63913979045, loc:(*time.Location)(0x33bfa5a7f340)}, UpdatedTime:api.Time{wall:0x122dee40, ext:63913979045, loc:(*time.Location)(0x33bfa5a7f340)}, ThirdTaskID:"", Phase:"PHASE_TYPE_PENDING", Progress:0, IconLink:"https://static.mypikpak.com/0ed033dfc7b3862af92a52ef7e3e4d257223df81", Callback:"", ReferenceResource:interface {}(nil), Space:""} 2026/05/10 03:04:20 DEBUG : pacer: Reducing sleep to 1.5s 2026/05/10 03:04:22 DEBUG : pacer: Reducing sleep to 1.125s 2026/05/10 03:04:24 DEBUG : pacer: Reducing sleep to 843.75ms 2026/05/10 03:04:24 DEBUG : ␉leading HT: waiting 500ms for the cancellation to be effective fstests.go:146: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:146 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:162 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:224 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:214 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:714 /usr/local/go/src/runtime/asm_amd64.s:1771 Error: Received unexpected error: can't verify the task is completed: &api.Task{Kind:"drive#task", ID:"VOsEpsqZcn7Ku0VP0fjc4xcZo2", Name:"upload", Type:"upload", UserID:"ZB7KFqZKGnYUJW_K", Statuses:[]interface {}{}, StatusSize:0, Params:(*api.TaskParams)(0x33bfa5f60600), FileID:"VOsEpsqEcn7Ku0VP0fjc4xcWo2", FileName:"␉leading HT", FileSize:"100", Message:"Pending", CreatedTime:api.Time{wall:0x10ed7f00, ext:63913979045, loc:(*time.Location)(0x33bfa5a7f340)}, UpdatedTime:api.Time{wall:0x122dee40, ext:63913979045, loc:(*time.Location)(0x33bfa5a7f340)}, ThirdTaskID:"", Phase:"PHASE_TYPE_PENDING", Progress:0, IconLink:"https://static.mypikpak.com/0ed033dfc7b3862af92a52ef7e3e4d257223df81", Callback:"", ReferenceResource:interface {}(nil), Space:""} Test: TestIntegration/FsMkdir/FsEncoding/leading_HT Messages: Put === RUN TestIntegration/FsMkdir/FsEncoding/leading_VT fstests.go:708: testing "␋leading VT" 2026/05/10 03:04:25 DEBUG : pacer: Reducing sleep to 632.8125ms 2026/05/10 03:04:26 DEBUG : pacer: Reducing sleep to 474.609375ms 2026/05/10 03:04:27 DEBUG : pacer: Reducing sleep to 355.957031ms 2026/05/10 03:04:27 DEBUG : ␋leading VT/␋leading VT: calculating gcid: failed to unwrap object from src: ␋leading VT/␋leading VT 2026/05/10 03:04:27 DEBUG : ␋leading VT/␋leading VT: gcid = acadd458aa9338f98029323be04e986b522fc1c9 2026/05/10 03:04:27 DEBUG : pacer: Reducing sleep to 266.967773ms 2026/05/10 03:04:28 DEBUG : pacer: Reducing sleep to 200.225829ms 2026/05/10 03:04:29 DEBUG : pacer: Reducing sleep to 150.169371ms 2026/05/10 03:04:29 DEBUG : pacer: Reducing sleep to 112.627028ms 2026/05/10 03:04:30 DEBUG : pacer: Reducing sleep to 100ms fstest.go:298: Sleeping for 1s for list eventual consistency: 1/3 fstest.go:301: Flushing the directory cache fstest.go:298: Sleeping for 2s for list eventual consistency: 2/3 fstest.go:301: Flushing the directory cache fstest.go:298: Sleeping for 4s for list eventual consistency: 3/3 fstest.go:301: Flushing the directory cache fstest.go:327: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:327 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:338 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:715 Error: Not equal: expected: []string{"␋leading VT"} actual : []string{"!\"#$%&'()*+,-./:;<=>?@[\\]^_`{|}~", "~leading tilde", "␉leading HT", "␋leading VT", "␍leading CR", ".."} Diff: --- Expected +++ Actual @@ -1,3 +1,8 @@ -([]string) (len=1) { - (string) (len=13) "␋leading VT" +([]string) (len=6) { + (string) (len=34) "!\"#$%&'()*+,-./:;<=>?@[\\]^_`{|}~", + (string) (len=14) "~leading tilde", + (string) (len=13) "␉leading HT", + (string) (len=13) "␋leading VT", + (string) (len=13) "␍leading CR", + (string) (len=6) ".." } Test: TestIntegration/FsMkdir/FsEncoding/leading_VT Messages: directories 2026/05/10 03:04:42 DEBUG : ␋leading VT: Rmdir: contains trashed file: "␋leading VT" fstest.go:298: Sleeping for 1s for list eventual consistency: 1/3 fstest.go:301: Flushing the directory cache fstest.go:298: Sleeping for 2s for list eventual consistency: 2/3 fstest.go:301: Flushing the directory cache fstest.go:298: Sleeping for 4s for list eventual consistency: 3/3 fstest.go:301: Flushing the directory cache fstest.go:327: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:327 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:338 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:718 Error: Not equal: expected: []string{} actual : []string{"!\"#$%&'()*+,-./:;<=>?@[\\]^_`{|}~", "~leading tilde", "␉leading HT", "␍leading CR", ".."} Diff: --- Expected +++ Actual @@ -1,2 +1,7 @@ -([]string) { +([]string) (len=5) { + (string) (len=34) "!\"#$%&'()*+,-./:;<=>?@[\\]^_`{|}~", + (string) (len=14) "~leading tilde", + (string) (len=13) "␉leading HT", + (string) (len=13) "␍leading CR", + (string) (len=6) ".." } Test: TestIntegration/FsMkdir/FsEncoding/leading_VT Messages: directories === RUN TestIntegration/FsMkdir/FsEncoding/leading_dot fstests.go:708: testing ".leading dot" 2026/05/10 03:04:55 DEBUG : .leading dot/.leading dot: calculating gcid: failed to unwrap object from src: .leading dot/.leading dot 2026/05/10 03:04:55 DEBUG : .leading dot/.leading dot: gcid = 42e98b5607f9fa8c5095fe2b40b8532bd28915d0 fstest.go:298: Sleeping for 1s for list eventual consistency: 1/3 fstest.go:301: Flushing the directory cache fstest.go:298: Sleeping for 2s for list eventual consistency: 2/3 fstest.go:301: Flushing the directory cache fstest.go:298: Sleeping for 4s for list eventual consistency: 3/3 fstest.go:301: Flushing the directory cache fstest.go:327: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:327 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:338 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:715 Error: Not equal: expected: []string{".leading dot"} actual : []string{"!\"#$%&'()*+,-./:;<=>?@[\\]^_`{|}~", ".leading dot", "~leading tilde", "␉leading HT", "␍leading CR", ".."} Diff: --- Expected +++ Actual @@ -1,3 +1,8 @@ -([]string) (len=1) { - (string) (len=12) ".leading dot" +([]string) (len=6) { + (string) (len=34) "!\"#$%&'()*+,-./:;<=>?@[\\]^_`{|}~", + (string) (len=12) ".leading dot", + (string) (len=14) "~leading tilde", + (string) (len=13) "␉leading HT", + (string) (len=13) "␍leading CR", + (string) (len=6) ".." } Test: TestIntegration/FsMkdir/FsEncoding/leading_dot Messages: directories 2026/05/10 03:05:10 DEBUG : .leading dot: Rmdir: contains trashed file: ".leading dot" fstest.go:298: Sleeping for 1s for list eventual consistency: 1/3 fstest.go:301: Flushing the directory cache fstest.go:298: Sleeping for 2s for list eventual consistency: 2/3 fstest.go:301: Flushing the directory cache fstest.go:298: Sleeping for 4s for list eventual consistency: 3/3 fstest.go:301: Flushing the directory cache fstest.go:327: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:327 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:338 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:718 Error: Not equal: expected: []string{} actual : []string{"!\"#$%&'()*+,-./:;<=>?@[\\]^_`{|}~", "~leading tilde", "␉leading HT", "␍leading CR", ".."} Diff: --- Expected +++ Actual @@ -1,2 +1,7 @@ -([]string) { +([]string) (len=5) { + (string) (len=34) "!\"#$%&'()*+,-./:;<=>?@[\\]^_`{|}~", + (string) (len=14) "~leading tilde", + (string) (len=13) "␉leading HT", + (string) (len=13) "␍leading CR", + (string) (len=6) ".." } Test: TestIntegration/FsMkdir/FsEncoding/leading_dot Messages: directories === RUN TestIntegration/FsMkdir/FsEncoding/trailing_space fstests.go:708: testing "trailing space " 2026/05/10 03:05:23 DEBUG : trailing space /trailing space : calculating gcid: failed to unwrap object from src: trailing space /trailing space 2026/05/10 03:05:23 DEBUG : trailing space /trailing space : gcid = c66de5daed033e733a0556f1b6bf476ff827e71f 2026/05/10 03:05:26 DEBUG : pacer: low level retry 1/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:05:26 DEBUG : pacer: Rate limited, increasing sleep to 200ms 2026/05/10 03:05:26 DEBUG : pacer: low level retry 2/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:05:26 DEBUG : pacer: Rate limited, increasing sleep to 400ms 2026/05/10 03:05:26 DEBUG : pacer: low level retry 3/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:05:26 DEBUG : pacer: Rate limited, increasing sleep to 800ms 2026/05/10 03:05:27 DEBUG : pacer: low level retry 4/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:05:27 DEBUG : pacer: Rate limited, increasing sleep to 1.6s 2026/05/10 03:05:27 DEBUG : pacer: low level retry 5/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:05:27 DEBUG : pacer: Rate limited, increasing sleep to 2s 2026/05/10 03:05:29 DEBUG : pacer: low level retry 6/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:05:31 DEBUG : pacer: low level retry 7/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:05:33 DEBUG : pacer: low level retry 8/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:05:35 DEBUG : pacer: low level retry 9/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:05:37 DEBUG : pacer: low level retry 10/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:05:37 DEBUG : trailing space : canceling upload: can't verify the task is completed: &api.Task{Kind:"drive#task", ID:"VOsEqB1xlYLADoMYgilGHhATo2", Name:"upload", Type:"upload", UserID:"ZB7KFqZKGnYUJW_K", Statuses:[]interface {}{}, StatusSize:0, Params:(*api.TaskParams)(0x33bfa5e70600), FileID:"VOsEqB1jlYLADoMYgilGHhAQo2", FileName:"trailing space␠", FileSize:"100", Message:"Pending", CreatedTime:api.Time{wall:0x35b42b40, ext:63913979123, loc:(*time.Location)(0x33bfa5a7f340)}, UpdatedTime:api.Time{wall:0x36c6d3c0, ext:63913979123, loc:(*time.Location)(0x33bfa5a7f340)}, ThirdTaskID:"", Phase:"PHASE_TYPE_PENDING", Progress:0, IconLink:"https://static.mypikpak.com/0ed033dfc7b3862af92a52ef7e3e4d257223df81", Callback:"", ReferenceResource:interface {}(nil), Space:""} 2026/05/10 03:05:39 DEBUG : pacer: Reducing sleep to 1.5s 2026/05/10 03:05:41 DEBUG : pacer: Reducing sleep to 1.125s 2026/05/10 03:05:43 DEBUG : pacer: Reducing sleep to 843.75ms 2026/05/10 03:05:43 DEBUG : trailing space : waiting 500ms for the cancellation to be effective fstests.go:146: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:146 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:162 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:224 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:214 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:714 /usr/local/go/src/runtime/asm_amd64.s:1771 Error: Received unexpected error: can't verify the task is completed: &api.Task{Kind:"drive#task", ID:"VOsEqB1xlYLADoMYgilGHhATo2", Name:"upload", Type:"upload", UserID:"ZB7KFqZKGnYUJW_K", Statuses:[]interface {}{}, StatusSize:0, Params:(*api.TaskParams)(0x33bfa5e70600), FileID:"VOsEqB1jlYLADoMYgilGHhAQo2", FileName:"trailing space␠", FileSize:"100", Message:"Pending", CreatedTime:api.Time{wall:0x35b42b40, ext:63913979123, loc:(*time.Location)(0x33bfa5a7f340)}, UpdatedTime:api.Time{wall:0x36c6d3c0, ext:63913979123, loc:(*time.Location)(0x33bfa5a7f340)}, ThirdTaskID:"", Phase:"PHASE_TYPE_PENDING", Progress:0, IconLink:"https://static.mypikpak.com/0ed033dfc7b3862af92a52ef7e3e4d257223df81", Callback:"", ReferenceResource:interface {}(nil), Space:""} Test: TestIntegration/FsMkdir/FsEncoding/trailing_space Messages: Put === RUN TestIntegration/FsMkdir/FsEncoding/trailing_CR fstests.go:708: testing "trailing CR␍" 2026/05/10 03:05:44 DEBUG : pacer: Reducing sleep to 632.8125ms 2026/05/10 03:05:45 DEBUG : pacer: Reducing sleep to 474.609375ms 2026/05/10 03:05:45 DEBUG : pacer: Reducing sleep to 355.957031ms 2026/05/10 03:05:45 DEBUG : trailing CR␍/trailing CR␍: calculating gcid: failed to unwrap object from src: trailing CR␍/trailing CR␍ 2026/05/10 03:05:45 DEBUG : trailing CR␍/trailing CR␍: gcid = 0ac7cac52141cfec0f992db8bd39113466036476 2026/05/10 03:05:46 DEBUG : pacer: Reducing sleep to 266.967773ms 2026/05/10 03:05:47 DEBUG : pacer: Reducing sleep to 200.225829ms 2026/05/10 03:05:48 DEBUG : pacer: low level retry 1/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:05:48 DEBUG : pacer: Rate limited, increasing sleep to 400.451658ms 2026/05/10 03:05:48 DEBUG : pacer: low level retry 2/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:05:48 DEBUG : pacer: Rate limited, increasing sleep to 800.903316ms 2026/05/10 03:05:48 DEBUG : pacer: low level retry 3/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:05:48 DEBUG : pacer: Rate limited, increasing sleep to 1.601806632s 2026/05/10 03:05:49 DEBUG : pacer: low level retry 4/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:05:49 DEBUG : pacer: Rate limited, increasing sleep to 2s 2026/05/10 03:05:51 DEBUG : pacer: low level retry 5/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:05:53 DEBUG : pacer: low level retry 6/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:05:55 DEBUG : pacer: low level retry 7/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:05:57 DEBUG : pacer: low level retry 8/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:05:59 DEBUG : pacer: low level retry 9/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:06:01 DEBUG : pacer: low level retry 10/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:06:01 DEBUG : trailing CR␍: canceling upload: can't verify the task is completed: &api.Task{Kind:"drive#task", ID:"VOsEqGReTXN5L5GxxIb37b2Eo2", Name:"upload", Type:"upload", UserID:"ZB7KFqZKGnYUJW_K", Statuses:[]interface {}{}, StatusSize:0, Params:(*api.TaskParams)(0x33bfa5e71700), FileID:"VOsEqGRKTXN5L5GxxIb37b2Bo2", FileName:"trailing CR␍", FileSize:"100", Message:"Pending", CreatedTime:api.Time{wall:0x18cba80, ext:63913979146, loc:(*time.Location)(0x33bfa5a7f340)}, UpdatedTime:api.Time{wall:0x29020c0, ext:63913979146, loc:(*time.Location)(0x33bfa5a7f340)}, ThirdTaskID:"", Phase:"PHASE_TYPE_PENDING", Progress:0, IconLink:"https://static.mypikpak.com/0ed033dfc7b3862af92a52ef7e3e4d257223df81", Callback:"", ReferenceResource:interface {}(nil), Space:""} 2026/05/10 03:06:03 DEBUG : pacer: Reducing sleep to 1.5s 2026/05/10 03:06:05 DEBUG : pacer: Reducing sleep to 1.125s 2026/05/10 03:06:06 DEBUG : pacer: Reducing sleep to 843.75ms 2026/05/10 03:06:06 DEBUG : trailing CR␍: waiting 500ms for the cancellation to be effective fstests.go:146: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:146 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:162 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:224 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:214 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:714 /usr/local/go/src/runtime/asm_amd64.s:1771 Error: Received unexpected error: can't verify the task is completed: &api.Task{Kind:"drive#task", ID:"VOsEqGReTXN5L5GxxIb37b2Eo2", Name:"upload", Type:"upload", UserID:"ZB7KFqZKGnYUJW_K", Statuses:[]interface {}{}, StatusSize:0, Params:(*api.TaskParams)(0x33bfa5e71700), FileID:"VOsEqGRKTXN5L5GxxIb37b2Bo2", FileName:"trailing CR␍", FileSize:"100", Message:"Pending", CreatedTime:api.Time{wall:0x18cba80, ext:63913979146, loc:(*time.Location)(0x33bfa5a7f340)}, UpdatedTime:api.Time{wall:0x29020c0, ext:63913979146, loc:(*time.Location)(0x33bfa5a7f340)}, ThirdTaskID:"", Phase:"PHASE_TYPE_PENDING", Progress:0, IconLink:"https://static.mypikpak.com/0ed033dfc7b3862af92a52ef7e3e4d257223df81", Callback:"", ReferenceResource:interface {}(nil), Space:""} Test: TestIntegration/FsMkdir/FsEncoding/trailing_CR Messages: Put === RUN TestIntegration/FsMkdir/FsEncoding/trailing_LF fstests.go:708: testing "trailing LF␊" 2026/05/10 03:06:08 DEBUG : pacer: Reducing sleep to 632.8125ms 2026/05/10 03:06:08 DEBUG : pacer: Reducing sleep to 474.609375ms 2026/05/10 03:06:09 DEBUG : pacer: Reducing sleep to 355.957031ms 2026/05/10 03:06:09 DEBUG : trailing LF␊/trailing LF␊: calculating gcid: failed to unwrap object from src: trailing LF␊/trailing LF␊ 2026/05/10 03:06:09 DEBUG : trailing LF␊/trailing LF␊: gcid = 15a08da3705574cb3749bf1dd5c84d601de5118b 2026/05/10 03:06:10 DEBUG : pacer: Reducing sleep to 266.967773ms 2026/05/10 03:06:11 DEBUG : pacer: Reducing sleep to 200.225829ms 2026/05/10 03:06:12 DEBUG : pacer: low level retry 1/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:06:12 DEBUG : pacer: Rate limited, increasing sleep to 400.451658ms 2026/05/10 03:06:12 DEBUG : pacer: low level retry 2/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:06:12 DEBUG : pacer: Rate limited, increasing sleep to 800.903316ms 2026/05/10 03:06:12 DEBUG : pacer: low level retry 3/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:06:12 DEBUG : pacer: Rate limited, increasing sleep to 1.601806632s 2026/05/10 03:06:13 DEBUG : pacer: low level retry 4/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:06:13 DEBUG : pacer: Rate limited, increasing sleep to 2s 2026/05/10 03:06:15 DEBUG : pacer: low level retry 5/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:06:17 DEBUG : pacer: low level retry 6/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:06:19 DEBUG : pacer: low level retry 7/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:06:21 DEBUG : pacer: low level retry 8/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:06:23 DEBUG : pacer: low level retry 9/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:06:25 DEBUG : pacer: low level retry 10/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:06:25 DEBUG : trailing LF␊: canceling upload: can't verify the task is completed: &api.Task{Kind:"drive#task", ID:"VOsEqMF28nT_95fVzZ4_B1uPo2", Name:"upload", Type:"upload", UserID:"ZB7KFqZKGnYUJW_K", Statuses:[]interface {}{}, StatusSize:0, Params:(*api.TaskParams)(0x33bfa5f60a80), FileID:"VOsEqMEi8nT_95fVzZ4_B1uNo2", FileName:"trailing LF␊", FileSize:"100", Message:"Pending", CreatedTime:api.Time{wall:0x2f62bcc0, ext:63913979169, loc:(*time.Location)(0x33bfa5a7f340)}, UpdatedTime:api.Time{wall:0x30a32c00, ext:63913979169, loc:(*time.Location)(0x33bfa5a7f340)}, ThirdTaskID:"", Phase:"PHASE_TYPE_PENDING", Progress:0, IconLink:"https://static.mypikpak.com/0ed033dfc7b3862af92a52ef7e3e4d257223df81", Callback:"", ReferenceResource:interface {}(nil), Space:""} 2026/05/10 03:06:27 DEBUG : pacer: Reducing sleep to 1.5s 2026/05/10 03:06:29 DEBUG : pacer: Reducing sleep to 1.125s 2026/05/10 03:06:31 DEBUG : Saving config "captcha_token" in section "TestPikPak" of the config file 2026/05/10 03:06:31 DEBUG : Config file has changed externally - reloading 2026/05/10 03:06:31 DEBUG : pacer: Reducing sleep to 843.75ms 2026/05/10 03:06:31 DEBUG : trailing LF␊: waiting 500ms for the cancellation to be effective fstests.go:146: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:146 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:162 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:224 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:214 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:714 /usr/local/go/src/runtime/asm_amd64.s:1771 Error: Received unexpected error: can't verify the task is completed: &api.Task{Kind:"drive#task", ID:"VOsEqMF28nT_95fVzZ4_B1uPo2", Name:"upload", Type:"upload", UserID:"ZB7KFqZKGnYUJW_K", Statuses:[]interface {}{}, StatusSize:0, Params:(*api.TaskParams)(0x33bfa5f60a80), FileID:"VOsEqMEi8nT_95fVzZ4_B1uNo2", FileName:"trailing LF␊", FileSize:"100", Message:"Pending", CreatedTime:api.Time{wall:0x2f62bcc0, ext:63913979169, loc:(*time.Location)(0x33bfa5a7f340)}, UpdatedTime:api.Time{wall:0x30a32c00, ext:63913979169, loc:(*time.Location)(0x33bfa5a7f340)}, ThirdTaskID:"", Phase:"PHASE_TYPE_PENDING", Progress:0, IconLink:"https://static.mypikpak.com/0ed033dfc7b3862af92a52ef7e3e4d257223df81", Callback:"", ReferenceResource:interface {}(nil), Space:""} Test: TestIntegration/FsMkdir/FsEncoding/trailing_LF Messages: Put === RUN TestIntegration/FsMkdir/FsEncoding/trailing_HT fstests.go:708: testing "trailing HT␉" 2026/05/10 03:06:32 DEBUG : pacer: Reducing sleep to 632.8125ms 2026/05/10 03:06:33 DEBUG : pacer: Reducing sleep to 474.609375ms 2026/05/10 03:06:33 DEBUG : pacer: Reducing sleep to 355.957031ms 2026/05/10 03:06:33 DEBUG : trailing HT␉/trailing HT␉: calculating gcid: failed to unwrap object from src: trailing HT␉/trailing HT␉ 2026/05/10 03:06:33 DEBUG : trailing HT␉/trailing HT␉: gcid = fe26d3d3fbcc0313bfa3abf01465c58e0194569c 2026/05/10 03:06:34 DEBUG : pacer: Reducing sleep to 266.967773ms 2026/05/10 03:06:35 DEBUG : pacer: Reducing sleep to 200.225829ms 2026/05/10 03:06:36 DEBUG : pacer: low level retry 1/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:06:36 DEBUG : pacer: Rate limited, increasing sleep to 400.451658ms 2026/05/10 03:06:36 DEBUG : pacer: low level retry 2/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:06:36 DEBUG : pacer: Rate limited, increasing sleep to 800.903316ms 2026/05/10 03:06:37 DEBUG : pacer: low level retry 3/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:06:37 DEBUG : pacer: Rate limited, increasing sleep to 1.601806632s 2026/05/10 03:06:37 DEBUG : pacer: low level retry 4/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:06:37 DEBUG : pacer: Rate limited, increasing sleep to 2s 2026/05/10 03:06:39 DEBUG : pacer: low level retry 5/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:06:41 DEBUG : pacer: low level retry 6/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:06:43 DEBUG : pacer: low level retry 7/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:06:45 DEBUG : pacer: low level retry 8/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:06:47 DEBUG : pacer: low level retry 9/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:06:49 DEBUG : pacer: low level retry 10/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:06:49 DEBUG : trailing HT␉: canceling upload: can't verify the task is completed: &api.Task{Kind:"drive#task", ID:"VOsEqSC9V4VpQUFSQiwd2KCro2", Name:"upload", Type:"upload", UserID:"ZB7KFqZKGnYUJW_K", Statuses:[]interface {}{}, StatusSize:0, Params:(*api.TaskParams)(0x33bfa5e71140), FileID:"VOsEqSBtV4VpQUFSQiwd2KCpo2", FileName:"trailing HT␉", FileSize:"100", Message:"Pending", CreatedTime:api.Time{wall:0xb162280, ext:63913979194, loc:(*time.Location)(0x33bfa5a7f340)}, UpdatedTime:api.Time{wall:0xcc16180, ext:63913979194, loc:(*time.Location)(0x33bfa5a7f340)}, ThirdTaskID:"", Phase:"PHASE_TYPE_PENDING", Progress:0, IconLink:"https://static.mypikpak.com/0ed033dfc7b3862af92a52ef7e3e4d257223df81", Callback:"", ReferenceResource:interface {}(nil), Space:""} 2026/05/10 03:06:51 DEBUG : pacer: Reducing sleep to 1.5s 2026/05/10 03:06:53 DEBUG : pacer: Reducing sleep to 1.125s 2026/05/10 03:06:54 DEBUG : pacer: Reducing sleep to 843.75ms 2026/05/10 03:06:54 DEBUG : trailing HT␉: waiting 500ms for the cancellation to be effective fstests.go:146: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:146 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:162 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:224 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:214 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:714 /usr/local/go/src/runtime/asm_amd64.s:1771 Error: Received unexpected error: can't verify the task is completed: &api.Task{Kind:"drive#task", ID:"VOsEqSC9V4VpQUFSQiwd2KCro2", Name:"upload", Type:"upload", UserID:"ZB7KFqZKGnYUJW_K", Statuses:[]interface {}{}, StatusSize:0, Params:(*api.TaskParams)(0x33bfa5e71140), FileID:"VOsEqSBtV4VpQUFSQiwd2KCpo2", FileName:"trailing HT␉", FileSize:"100", Message:"Pending", CreatedTime:api.Time{wall:0xb162280, ext:63913979194, loc:(*time.Location)(0x33bfa5a7f340)}, UpdatedTime:api.Time{wall:0xcc16180, ext:63913979194, loc:(*time.Location)(0x33bfa5a7f340)}, ThirdTaskID:"", Phase:"PHASE_TYPE_PENDING", Progress:0, IconLink:"https://static.mypikpak.com/0ed033dfc7b3862af92a52ef7e3e4d257223df81", Callback:"", ReferenceResource:interface {}(nil), Space:""} Test: TestIntegration/FsMkdir/FsEncoding/trailing_HT Messages: Put === RUN TestIntegration/FsMkdir/FsEncoding/trailing_VT fstests.go:708: testing "trailing VT␋" 2026/05/10 03:06:56 DEBUG : pacer: Reducing sleep to 632.8125ms 2026/05/10 03:06:56 DEBUG : pacer: Reducing sleep to 474.609375ms 2026/05/10 03:06:57 DEBUG : pacer: Reducing sleep to 355.957031ms 2026/05/10 03:06:57 DEBUG : trailing VT␋/trailing VT␋: calculating gcid: failed to unwrap object from src: trailing VT␋/trailing VT␋ 2026/05/10 03:06:57 DEBUG : trailing VT␋/trailing VT␋: gcid = 3f819f3268cb41717b3bb8cd494006d057ce2dd8 2026/05/10 03:06:58 DEBUG : pacer: Reducing sleep to 266.967773ms 2026/05/10 03:06:59 DEBUG : pacer: Reducing sleep to 200.225829ms 2026/05/10 03:06:59 DEBUG : pacer: low level retry 1/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:06:59 DEBUG : pacer: Rate limited, increasing sleep to 400.451658ms 2026/05/10 03:07:00 DEBUG : pacer: low level retry 2/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:07:00 DEBUG : pacer: Rate limited, increasing sleep to 800.903316ms 2026/05/10 03:07:00 DEBUG : pacer: low level retry 3/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:07:00 DEBUG : pacer: Rate limited, increasing sleep to 1.601806632s 2026/05/10 03:07:01 DEBUG : pacer: low level retry 4/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:07:01 DEBUG : pacer: Rate limited, increasing sleep to 2s 2026/05/10 03:07:03 DEBUG : pacer: low level retry 5/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:07:05 DEBUG : pacer: low level retry 6/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:07:07 DEBUG : pacer: low level retry 7/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:07:09 DEBUG : pacer: low level retry 8/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:07:11 DEBUG : pacer: low level retry 9/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:07:13 DEBUG : pacer: low level retry 10/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:07:13 DEBUG : trailing VT␋: canceling upload: can't verify the task is completed: &api.Task{Kind:"drive#task", ID:"VOsEqXzRV4VpQUFSQiwd2M8xo2", Name:"upload", Type:"upload", UserID:"ZB7KFqZKGnYUJW_K", Statuses:[]interface {}{}, StatusSize:0, Params:(*api.TaskParams)(0x33bfa5e70600), FileID:"VOsEqXz7V4VpQUFSQiwd2M8to2", FileName:"trailing VT␋", FileSize:"100", Message:"Pending", CreatedTime:api.Time{wall:0x34b0c500, ext:63913979217, loc:(*time.Location)(0x33bfa5a7f340)}, UpdatedTime:api.Time{wall:0x35f13440, ext:63913979217, loc:(*time.Location)(0x33bfa5a7f340)}, ThirdTaskID:"", Phase:"PHASE_TYPE_PENDING", Progress:0, IconLink:"https://static.mypikpak.com/0ed033dfc7b3862af92a52ef7e3e4d257223df81", Callback:"", ReferenceResource:interface {}(nil), Space:""} 2026/05/10 03:07:15 DEBUG : pacer: Reducing sleep to 1.5s 2026/05/10 03:07:17 DEBUG : pacer: Reducing sleep to 1.125s 2026/05/10 03:07:18 DEBUG : pacer: Reducing sleep to 843.75ms 2026/05/10 03:07:18 DEBUG : trailing VT␋: waiting 500ms for the cancellation to be effective fstests.go:146: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:146 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:162 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:224 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:214 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:714 /usr/local/go/src/runtime/asm_amd64.s:1771 Error: Received unexpected error: can't verify the task is completed: &api.Task{Kind:"drive#task", ID:"VOsEqXzRV4VpQUFSQiwd2M8xo2", Name:"upload", Type:"upload", UserID:"ZB7KFqZKGnYUJW_K", Statuses:[]interface {}{}, StatusSize:0, Params:(*api.TaskParams)(0x33bfa5e70600), FileID:"VOsEqXz7V4VpQUFSQiwd2M8to2", FileName:"trailing VT␋", FileSize:"100", Message:"Pending", CreatedTime:api.Time{wall:0x34b0c500, ext:63913979217, loc:(*time.Location)(0x33bfa5a7f340)}, UpdatedTime:api.Time{wall:0x35f13440, ext:63913979217, loc:(*time.Location)(0x33bfa5a7f340)}, ThirdTaskID:"", Phase:"PHASE_TYPE_PENDING", Progress:0, IconLink:"https://static.mypikpak.com/0ed033dfc7b3862af92a52ef7e3e4d257223df81", Callback:"", ReferenceResource:interface {}(nil), Space:""} Test: TestIntegration/FsMkdir/FsEncoding/trailing_VT Messages: Put === RUN TestIntegration/FsMkdir/FsEncoding/trailing_dot fstests.go:708: testing "trailing dot." 2026/05/10 03:07:19 DEBUG : pacer: Reducing sleep to 632.8125ms 2026/05/10 03:07:20 DEBUG : pacer: Reducing sleep to 474.609375ms 2026/05/10 03:07:21 DEBUG : pacer: Reducing sleep to 355.957031ms 2026/05/10 03:07:21 DEBUG : trailing dot./trailing dot.: calculating gcid: failed to unwrap object from src: trailing dot./trailing dot. 2026/05/10 03:07:21 DEBUG : trailing dot./trailing dot.: gcid = c55330d2df30af91f711a7865917a6e49b570cf3 2026/05/10 03:07:21 DEBUG : pacer: Reducing sleep to 266.967773ms 2026/05/10 03:07:22 DEBUG : pacer: Reducing sleep to 200.225829ms 2026/05/10 03:07:23 DEBUG : pacer: low level retry 1/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:07:23 DEBUG : pacer: Rate limited, increasing sleep to 400.451658ms 2026/05/10 03:07:24 DEBUG : pacer: low level retry 2/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:07:24 DEBUG : pacer: Rate limited, increasing sleep to 800.903316ms 2026/05/10 03:07:24 DEBUG : pacer: low level retry 3/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:07:24 DEBUG : pacer: Rate limited, increasing sleep to 1.601806632s 2026/05/10 03:07:25 DEBUG : pacer: low level retry 4/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:07:25 DEBUG : pacer: Rate limited, increasing sleep to 2s 2026/05/10 03:07:26 DEBUG : pacer: low level retry 5/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:07:28 DEBUG : pacer: low level retry 6/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:07:30 DEBUG : pacer: low level retry 7/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:07:32 DEBUG : pacer: low level retry 8/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:07:34 DEBUG : pacer: low level retry 9/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:07:36 DEBUG : pacer: low level retry 10/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:07:36 DEBUG : trailing dot.: canceling upload: can't verify the task is completed: &api.Task{Kind:"drive#task", ID:"VOsEqcklySgp_jifiaHHMazIo2", Name:"upload", Type:"upload", UserID:"ZB7KFqZKGnYUJW_K", Statuses:[]interface {}{}, StatusSize:0, Params:(*api.TaskParams)(0x33bfa5e70500), FileID:"VOsEqckRySgp_jifiaHHMazGo2", FileName:"trailing dot.", FileSize:"100", Message:"Pending", CreatedTime:api.Time{wall:0x1f0dd440, ext:63913979241, loc:(*time.Location)(0x33bfa5a7f340)}, UpdatedTime:api.Time{wall:0x204e4380, ext:63913979241, loc:(*time.Location)(0x33bfa5a7f340)}, ThirdTaskID:"", Phase:"PHASE_TYPE_PENDING", Progress:0, IconLink:"https://static.mypikpak.com/0ed033dfc7b3862af92a52ef7e3e4d257223df81", Callback:"", ReferenceResource:interface {}(nil), Space:""} 2026/05/10 03:07:38 DEBUG : pacer: Reducing sleep to 1.5s 2026/05/10 03:07:40 DEBUG : pacer: Reducing sleep to 1.125s 2026/05/10 03:07:42 DEBUG : pacer: Reducing sleep to 843.75ms 2026/05/10 03:07:42 DEBUG : trailing dot.: waiting 500ms for the cancellation to be effective fstests.go:146: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:146 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:162 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:224 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:214 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:714 /usr/local/go/src/runtime/asm_amd64.s:1771 Error: Received unexpected error: can't verify the task is completed: &api.Task{Kind:"drive#task", ID:"VOsEqcklySgp_jifiaHHMazIo2", Name:"upload", Type:"upload", UserID:"ZB7KFqZKGnYUJW_K", Statuses:[]interface {}{}, StatusSize:0, Params:(*api.TaskParams)(0x33bfa5e70500), FileID:"VOsEqckRySgp_jifiaHHMazGo2", FileName:"trailing dot.", FileSize:"100", Message:"Pending", CreatedTime:api.Time{wall:0x1f0dd440, ext:63913979241, loc:(*time.Location)(0x33bfa5a7f340)}, UpdatedTime:api.Time{wall:0x204e4380, ext:63913979241, loc:(*time.Location)(0x33bfa5a7f340)}, ThirdTaskID:"", Phase:"PHASE_TYPE_PENDING", Progress:0, IconLink:"https://static.mypikpak.com/0ed033dfc7b3862af92a52ef7e3e4d257223df81", Callback:"", ReferenceResource:interface {}(nil), Space:""} Test: TestIntegration/FsMkdir/FsEncoding/trailing_dot Messages: Put === RUN TestIntegration/FsMkdir/FsEncoding/invalid_UTF-8 fstests.go:708: testing "invalid utf-8\xfe" 2026/05/10 03:07:43 DEBUG : pacer: Reducing sleep to 632.8125ms 2026/05/10 03:07:44 DEBUG : pacer: Reducing sleep to 474.609375ms 2026/05/10 03:07:44 DEBUG : pacer: Reducing sleep to 355.957031ms 2026/05/10 03:07:44 DEBUG : invalid utf-8/invalid utf-8: calculating gcid: failed to unwrap object from src: invalid utf-8/invalid utf-8 2026/05/10 03:07:44 DEBUG : invalid utf-8/invalid utf-8: gcid = 629d2c440e96fadd48e54cc6c22614881613dd83 2026/05/10 03:07:45 DEBUG : pacer: Reducing sleep to 266.967773ms 2026/05/10 03:07:46 DEBUG : pacer: Reducing sleep to 200.225829ms 2026/05/10 03:07:47 DEBUG : pacer: low level retry 1/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:07:47 DEBUG : pacer: Rate limited, increasing sleep to 400.451658ms 2026/05/10 03:07:47 DEBUG : pacer: low level retry 2/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:07:47 DEBUG : pacer: Rate limited, increasing sleep to 800.903316ms 2026/05/10 03:07:48 DEBUG : pacer: low level retry 3/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:07:48 DEBUG : pacer: Rate limited, increasing sleep to 1.601806632s 2026/05/10 03:07:49 DEBUG : pacer: low level retry 4/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:07:49 DEBUG : pacer: Rate limited, increasing sleep to 2s 2026/05/10 03:07:50 DEBUG : pacer: low level retry 5/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:07:52 DEBUG : pacer: low level retry 6/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:07:54 DEBUG : pacer: low level retry 7/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:07:56 DEBUG : pacer: low level retry 8/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:07:58 DEBUG : pacer: low level retry 9/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:08:00 DEBUG : pacer: low level retry 10/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:08:00 DEBUG : invalid utf-8: canceling upload: can't verify the task is completed: &api.Task{Kind:"drive#task", ID:"VOsEqiYvV4VpQUFSQiwd2NWjo2", Name:"upload", Type:"upload", UserID:"ZB7KFqZKGnYUJW_K", Statuses:[]interface {}{}, StatusSize:0, Params:(*api.TaskParams)(0x33bfa5e70dc0), FileID:"VOsEqiYYV4VpQUFSQiwd2NWfo2", FileName:"invalid utf-8‛FE", FileSize:"100", Message:"Pending", CreatedTime:api.Time{wall:0x10642ac0, ext:63913979265, loc:(*time.Location)(0x33bfa5a7f340)}, UpdatedTime:api.Time{wall:0x11b3dc40, ext:63913979265, loc:(*time.Location)(0x33bfa5a7f340)}, ThirdTaskID:"", Phase:"PHASE_TYPE_PENDING", Progress:0, IconLink:"https://static.mypikpak.com/0ed033dfc7b3862af92a52ef7e3e4d257223df81", Callback:"", ReferenceResource:interface {}(nil), Space:""} 2026/05/10 03:08:02 DEBUG : pacer: Reducing sleep to 1.5s 2026/05/10 03:08:04 DEBUG : pacer: Reducing sleep to 1.125s 2026/05/10 03:08:06 DEBUG : pacer: Reducing sleep to 843.75ms 2026/05/10 03:08:06 DEBUG : invalid utf-8: waiting 500ms for the cancellation to be effective fstests.go:146: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:146 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:162 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:224 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:214 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:714 /usr/local/go/src/runtime/asm_amd64.s:1771 Error: Received unexpected error: can't verify the task is completed: &api.Task{Kind:"drive#task", ID:"VOsEqiYvV4VpQUFSQiwd2NWjo2", Name:"upload", Type:"upload", UserID:"ZB7KFqZKGnYUJW_K", Statuses:[]interface {}{}, StatusSize:0, Params:(*api.TaskParams)(0x33bfa5e70dc0), FileID:"VOsEqiYYV4VpQUFSQiwd2NWfo2", FileName:"invalid utf-8‛FE", FileSize:"100", Message:"Pending", CreatedTime:api.Time{wall:0x10642ac0, ext:63913979265, loc:(*time.Location)(0x33bfa5a7f340)}, UpdatedTime:api.Time{wall:0x11b3dc40, ext:63913979265, loc:(*time.Location)(0x33bfa5a7f340)}, ThirdTaskID:"", Phase:"PHASE_TYPE_PENDING", Progress:0, IconLink:"https://static.mypikpak.com/0ed033dfc7b3862af92a52ef7e3e4d257223df81", Callback:"", ReferenceResource:interface {}(nil), Space:""} Test: TestIntegration/FsMkdir/FsEncoding/invalid_UTF-8 Messages: Put === RUN TestIntegration/FsMkdir/FsEncoding/URL_encoding fstests.go:708: testing "test%46.txt" 2026/05/10 03:08:07 DEBUG : pacer: Reducing sleep to 632.8125ms 2026/05/10 03:08:08 DEBUG : pacer: Reducing sleep to 474.609375ms 2026/05/10 03:08:08 DEBUG : pacer: Reducing sleep to 355.957031ms 2026/05/10 03:08:08 DEBUG : test%46.txt/test%46.txt: calculating gcid: failed to unwrap object from src: test%46.txt/test%46.txt 2026/05/10 03:08:08 DEBUG : test%46.txt/test%46.txt: gcid = 8a3126ada4d9859f8af145f51accbe1adf97fd93 2026/05/10 03:08:09 DEBUG : pacer: Reducing sleep to 266.967773ms 2026/05/10 03:08:10 DEBUG : pacer: Reducing sleep to 200.225829ms 2026/05/10 03:08:11 DEBUG : pacer: low level retry 1/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:08:11 DEBUG : pacer: Rate limited, increasing sleep to 400.451658ms 2026/05/10 03:08:11 DEBUG : pacer: low level retry 2/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:08:11 DEBUG : pacer: Rate limited, increasing sleep to 800.903316ms 2026/05/10 03:08:11 DEBUG : pacer: low level retry 3/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:08:11 DEBUG : pacer: Rate limited, increasing sleep to 1.601806632s 2026/05/10 03:08:12 DEBUG : pacer: low level retry 4/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:08:12 DEBUG : pacer: Rate limited, increasing sleep to 2s 2026/05/10 03:08:14 DEBUG : pacer: low level retry 5/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:08:16 DEBUG : pacer: low level retry 6/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:08:18 DEBUG : pacer: low level retry 7/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:08:20 DEBUG : pacer: low level retry 8/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:08:22 DEBUG : pacer: low level retry 9/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:08:24 DEBUG : pacer: low level retry 10/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:08:24 DEBUG : test%46.txt: canceling upload: can't verify the task is completed: &api.Task{Kind:"drive#task", ID:"VOsEqoNiC8Xb_QYTen6OCZW9o2", Name:"upload", Type:"upload", UserID:"ZB7KFqZKGnYUJW_K", Statuses:[]interface {}{}, StatusSize:0, Params:(*api.TaskParams)(0x33bfa5a7d280), FileID:"VOsEqoNGC8Xb_QYTen6OCZW7o2", FileName:"test%46.txt", FileSize:"100", Message:"Pending", CreatedTime:api.Time{wall:0x7fcad80, ext:63913979289, loc:(*time.Location)(0x33bfa5a7f340)}, UpdatedTime:api.Time{wall:0x8f0d180, ext:63913979289, loc:(*time.Location)(0x33bfa5a7f340)}, ThirdTaskID:"", Phase:"PHASE_TYPE_PENDING", Progress:0, IconLink:"https://static.mypikpak.com/0d8b20b308a8f2fb094caba73cd2b809f7f3c636", Callback:"", ReferenceResource:interface {}(nil), Space:""} 2026/05/10 03:08:26 DEBUG : pacer: Reducing sleep to 1.5s 2026/05/10 03:08:28 DEBUG : pacer: Reducing sleep to 1.125s 2026/05/10 03:08:29 DEBUG : pacer: Reducing sleep to 843.75ms 2026/05/10 03:08:29 DEBUG : test%46.txt: waiting 500ms for the cancellation to be effective fstests.go:146: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:146 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:162 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:224 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:214 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:714 /usr/local/go/src/runtime/asm_amd64.s:1771 Error: Received unexpected error: can't verify the task is completed: &api.Task{Kind:"drive#task", ID:"VOsEqoNiC8Xb_QYTen6OCZW9o2", Name:"upload", Type:"upload", UserID:"ZB7KFqZKGnYUJW_K", Statuses:[]interface {}{}, StatusSize:0, Params:(*api.TaskParams)(0x33bfa5a7d280), FileID:"VOsEqoNGC8Xb_QYTen6OCZW7o2", FileName:"test%46.txt", FileSize:"100", Message:"Pending", CreatedTime:api.Time{wall:0x7fcad80, ext:63913979289, loc:(*time.Location)(0x33bfa5a7f340)}, UpdatedTime:api.Time{wall:0x8f0d180, ext:63913979289, loc:(*time.Location)(0x33bfa5a7f340)}, ThirdTaskID:"", Phase:"PHASE_TYPE_PENDING", Progress:0, IconLink:"https://static.mypikpak.com/0d8b20b308a8f2fb094caba73cd2b809f7f3c636", Callback:"", ReferenceResource:interface {}(nil), Space:""} Test: TestIntegration/FsMkdir/FsEncoding/URL_encoding Messages: Put === RUN TestIntegration/FsMkdir/FsPutFiles 2026/05/10 03:08:30 DEBUG : pacer: Reducing sleep to 632.8125ms 2026/05/10 03:08:30 DEBUG : file name.txt: calculating gcid: failed to unwrap object from src: file name.txt 2026/05/10 03:08:30 DEBUG : file name.txt: gcid = e54a0b12f9cc3ff6fcb65556022139c314b5c864 2026/05/10 03:08:31 DEBUG : pacer: Reducing sleep to 474.609375ms 2026/05/10 03:08:33 DEBUG : pacer: Reducing sleep to 355.957031ms 2026/05/10 03:08:34 DEBUG : pacer: low level retry 1/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:08:34 DEBUG : pacer: Rate limited, increasing sleep to 711.914062ms 2026/05/10 03:08:34 DEBUG : pacer: low level retry 2/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:08:34 DEBUG : pacer: Rate limited, increasing sleep to 1.423828124s 2026/05/10 03:08:35 DEBUG : pacer: low level retry 3/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:08:35 DEBUG : pacer: Rate limited, increasing sleep to 2s 2026/05/10 03:08:36 DEBUG : pacer: low level retry 4/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:08:38 DEBUG : pacer: low level retry 5/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:08:40 DEBUG : pacer: low level retry 6/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:08:42 DEBUG : pacer: low level retry 7/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:08:44 DEBUG : pacer: low level retry 8/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:08:46 DEBUG : pacer: low level retry 9/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:08:48 DEBUG : pacer: low level retry 10/10 (error upload (upload) is still in PHASE_TYPE_PENDING) 2026/05/10 03:08:48 DEBUG : file name.txt: canceling upload: can't verify the task is completed: &api.Task{Kind:"drive#task", ID:"VOsEqtsxqW4r6n2NPGHFiwFro2", Name:"upload", Type:"upload", UserID:"ZB7KFqZKGnYUJW_K", Statuses:[]interface {}{}, StatusSize:0, Params:(*api.TaskParams)(0x33bfa5c9bb40), FileID:"VOsEqtsZqW4r6n2NPGHFiwFno2", FileName:"file name.txt", FileSize:"100", Message:"Pending", CreatedTime:api.Time{wall:0x285a3340, ext:63913979311, loc:(*time.Location)(0x33bfa5a7f340)}, UpdatedTime:api.Time{wall:0x298b6040, ext:63913979311, loc:(*time.Location)(0x33bfa5a7f340)}, ThirdTaskID:"", Phase:"PHASE_TYPE_PENDING", Progress:0, IconLink:"https://static.mypikpak.com/0d8b20b308a8f2fb094caba73cd2b809f7f3c636", Callback:"", ReferenceResource:interface {}(nil), Space:""} 2026/05/10 03:08:50 DEBUG : pacer: Reducing sleep to 1.5s 2026/05/10 03:08:52 DEBUG : pacer: Reducing sleep to 1.125s 2026/05/10 03:08:54 DEBUG : pacer: Reducing sleep to 843.75ms 2026/05/10 03:08:54 DEBUG : file name.txt: waiting 500ms for the cancellation to be effective fstests.go:146: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:146 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:162 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:224 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:214 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:958 /usr/local/go/src/runtime/asm_amd64.s:1771 Error: Received unexpected error: can't verify the task is completed: &api.Task{Kind:"drive#task", ID:"VOsEqtsxqW4r6n2NPGHFiwFro2", Name:"upload", Type:"upload", UserID:"ZB7KFqZKGnYUJW_K", Statuses:[]interface {}{}, StatusSize:0, Params:(*api.TaskParams)(0x33bfa5c9bb40), FileID:"VOsEqtsZqW4r6n2NPGHFiwFno2", FileName:"file name.txt", FileSize:"100", Message:"Pending", CreatedTime:api.Time{wall:0x285a3340, ext:63913979311, loc:(*time.Location)(0x33bfa5a7f340)}, UpdatedTime:api.Time{wall:0x298b6040, ext:63913979311, loc:(*time.Location)(0x33bfa5a7f340)}, ThirdTaskID:"", Phase:"PHASE_TYPE_PENDING", Progress:0, IconLink:"https://static.mypikpak.com/0d8b20b308a8f2fb094caba73cd2b809f7f3c636", Callback:"", ReferenceResource:interface {}(nil), Space:""} Test: TestIntegration/FsMkdir/FsPutFiles Messages: Put 2026/05/10 03:08:55 DEBUG : pacer: Reducing sleep to 632.8125ms 2026/05/10 03:08:56 DEBUG : pacer: Reducing sleep to 474.609375ms 2026/05/10 03:08:56 DEBUG : pacer: Reducing sleep to 355.957031ms 2026/05/10 03:08:56 ERROR : error listing: directory not found 2026/05/10 03:08:57 DEBUG : pacer: Reducing sleep to 266.967773ms --- FAIL: TestIntegration (486.39s) --- FAIL: TestIntegration/FsMkdir (484.08s) --- FAIL: TestIntegration/FsMkdir/FsEncoding (457.02s) --- PASS: TestIntegration/FsMkdir/FsEncoding/dot (23.01s) --- FAIL: TestIntegration/FsMkdir/FsEncoding/dot_dot (20.57s) --- FAIL: TestIntegration/FsMkdir/FsEncoding/punctuation (24.71s) --- FAIL: TestIntegration/FsMkdir/FsEncoding/leading_space (35.84s) --- FAIL: TestIntegration/FsMkdir/FsEncoding/leading_tilde (21.05s) --- FAIL: TestIntegration/FsMkdir/FsEncoding/leading_CR (23.75s) --- FAIL: TestIntegration/FsMkdir/FsEncoding/leading_LF (41.37s) --- FAIL: TestIntegration/FsMkdir/FsEncoding/leading_HT (21.03s) --- FAIL: TestIntegration/FsMkdir/FsEncoding/leading_VT (29.30s) --- FAIL: TestIntegration/FsMkdir/FsEncoding/leading_dot (28.28s) --- FAIL: TestIntegration/FsMkdir/FsEncoding/trailing_space (21.08s) --- FAIL: TestIntegration/FsMkdir/FsEncoding/trailing_CR (23.76s) --- FAIL: TestIntegration/FsMkdir/FsEncoding/trailing_LF (24.73s) --- FAIL: TestIntegration/FsMkdir/FsEncoding/trailing_HT (23.38s) --- FAIL: TestIntegration/FsMkdir/FsEncoding/trailing_VT (23.61s) --- FAIL: TestIntegration/FsMkdir/FsEncoding/trailing_dot (23.76s) --- FAIL: TestIntegration/FsMkdir/FsEncoding/invalid_UTF-8 (23.85s) --- FAIL: TestIntegration/FsMkdir/FsEncoding/URL_encoding (23.65s) --- FAIL: TestIntegration/FsMkdir/FsPutFiles (24.21s) FAIL exit status 1 FAIL github.com/rclone/rclone/backend/pikpak 486.407s "go test -v -timeout 1h0m0s -remote TestPikPak: -verbose -test.run '^TestIntegration$/^FsMkdir$/^FsEncoding$/^(URL_encoding|dot|dot_dot|invalid_UTF-8|leading_CR|leading_HT|leading_LF|leading_VT|leading_dot|leading_space|leading_tilde|punctuation|trailing_CR|trailing_HT|trailing_LF|trailing_VT|trailing_dot|trailing_space)$|^TestIntegration$/^FsMkdir$/^FsPutFiles$'" - Finished ERROR in 8m7.39716055s (try 3/5): exit status 1: Failed [TestIntegration/FsMkdir/FsEncoding/dot_dot TestIntegration/FsMkdir/FsEncoding/punctuation TestIntegration/FsMkdir/FsEncoding/leading_space TestIntegration/FsMkdir/FsEncoding/leading_tilde TestIntegration/FsMkdir/FsEncoding/leading_CR TestIntegration/FsMkdir/FsEncoding/leading_LF TestIntegration/FsMkdir/FsEncoding/leading_HT TestIntegration/FsMkdir/FsEncoding/leading_VT TestIntegration/FsMkdir/FsEncoding/leading_dot TestIntegration/FsMkdir/FsEncoding/trailing_space TestIntegration/FsMkdir/FsEncoding/trailing_CR TestIntegration/FsMkdir/FsEncoding/trailing_LF TestIntegration/FsMkdir/FsEncoding/trailing_HT TestIntegration/FsMkdir/FsEncoding/trailing_VT TestIntegration/FsMkdir/FsEncoding/trailing_dot TestIntegration/FsMkdir/FsEncoding/invalid_UTF-8 TestIntegration/FsMkdir/FsEncoding/URL_encoding TestIntegration/FsMkdir/FsPutFiles]