"./bisync.test -test.v -test.timeout 1h0m0s -remote 'TestGoogleCloudStorage,directory_markers:' -verbose" - Starting (try 1/5) 2025/04/08 05:46:41 DEBUG : Creating backend with remote "TestGoogleCloudStorage,directory_markers:rclone-test-tutejes2buro" 2025/04/08 05:46:41 DEBUG : Using config file from "/home/rclone/.rclone.conf" 2025/04/08 05:46:41 DEBUG : TestGoogleCloudStorage: detected overridden config - adding "{juk_h}" suffix to name 2025/04/08 05:46:41 DEBUG : Creating backend with remote "/tmp/rclone1398332206" === RUN TestBisyncRemoteLocal 2025/04/08 05:46:41 DEBUG : Creating backend with remote "TestGoogleCloudStorage,directory_markers:rclone-test-hojucip4quro" 2025/04/08 05:46:41 DEBUG : TestGoogleCloudStorage: detected overridden config - adding "{juk_h}" suffix to name 2025/04/08 05:46:41 NOTICE: remote: TestGoogleCloudStorage,directory_markers:rclone-test-hojucip4quro === RUN TestBisyncRemoteLocal/all_changed 2025/04/08 05:46:41 DEBUG : Creating backend with remote "TestGoogleCloudStorage,directory_markers:rclone-test-hojucip4quro/054641hu" 2025/04/08 05:46:41 DEBUG : Using config file from "/home/rclone/.rclone.conf" 2025/04/08 05:46:41 DEBUG : TestGoogleCloudStorage: detected overridden config - adding "{juk_h}" suffix to name 2025/04/08 05:46:41 DEBUG : fs cache: renaming cache item "TestGoogleCloudStorage,directory_markers:rclone-test-hojucip4quro/054641hu" to be canonical "TestGoogleCloudStorage{juk_h}:rclone-test-hojucip4quro/054641hu" 2025/04/08 05:46:41 INFO : path1: Making directory 2025/04/08 05:46:43 DEBUG : path1/: Creating directory marker 2025/04/08 05:46:43 DEBUG : Creating backend with remote "TestGoogleCloudStorage,directory_markers:rclone-test-hojucip4quro/054641hu/all_changed/path1" 2025/04/08 05:46:43 DEBUG : TestGoogleCloudStorage: detected overridden config - adding "{juk_h}" suffix to name 2025/04/08 05:46:43 DEBUG : fs cache: renaming cache item "TestGoogleCloudStorage,directory_markers:rclone-test-hojucip4quro/054641hu/all_changed/path1" to be canonical "TestGoogleCloudStorage{juk_h}:rclone-test-hojucip4quro/054641hu/all_changed/path1" 2025/04/08 05:46:43 DEBUG : Creating backend with remote "/tmp/054641hu" 2025/04/08 05:46:43 DEBUG : Creating backend with remote "/tmp/054641hu/all_changed/path2" 2025/04/08 05:46:43 DEBUG : Creating backend with remote "/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/testdata/test_all_changed/initial" 2025/04/08 05:46:43 DEBUG : Creating backend with remote "/tmp/054641hu/initdir/test_all_changed-xobixuw1" 2025/04/08 05:46:43 DEBUG : RCLONE_TEST: Need to transfer - File not found at Destination 2025/04/08 05:46:43 DEBUG : file1.copy1.txt: Need to transfer - File not found at Destination 2025/04/08 05:46:43 DEBUG : file1.copy2.txt: Need to transfer - File not found at Destination 2025/04/08 05:46:43 DEBUG : file1.copy3.txt: Need to transfer - File not found at Destination 2025/04/08 05:46:43 DEBUG : file1.copy4.txt: Need to transfer - File not found at Destination 2025/04/08 05:46:43 DEBUG : file1.copy5.txt: Need to transfer - File not found at Destination 2025/04/08 05:46:43 DEBUG : file1.txt: Need to transfer - File not found at Destination 2025/04/08 05:46:43 DEBUG : subdir: Making directory with metadata 2025/04/08 05:46:43 INFO : subdir: Made directory with metadata (mtime=2021-11-02T05:00:07Z) 2025/04/08 05:46:43 DEBUG : Added delayed dir = "subdir", newDst=subdir 2025/04/08 05:46:43 DEBUG : subdir/file20.txt: Need to transfer - File not found at Destination 2025/04/08 05:46:43 DEBUG : Local file system at /tmp/054641hu/initdir/test_all_changed-xobixuw1: Waiting for checks to finish 2025/04/08 05:46:43 DEBUG : file1.copy1.txt: md5 = d41d8cd98f00b204e9800998ecf8427e OK 2025/04/08 05:46:43 DEBUG : file1.copy1.txt.5028a97.partial: renamed to: file1.copy1.txt 2025/04/08 05:46:43 INFO : file1.copy1.txt: Copied (new) 2025/04/08 05:46:43 DEBUG : Local file system at /tmp/054641hu/initdir/test_all_changed-xobixuw1: Waiting for transfers to finish 2025/04/08 05:46:43 DEBUG : RCLONE_TEST: md5 = 294d25b294ff26a5243dba914ac3fbf7 OK 2025/04/08 05:46:43 DEBUG : RCLONE_TEST.cf9a93ac.partial: renamed to: RCLONE_TEST 2025/04/08 05:46:43 INFO : RCLONE_TEST: Copied (new) 2025/04/08 05:46:43 DEBUG : file1.copy3.txt: md5 = d41d8cd98f00b204e9800998ecf8427e OK 2025/04/08 05:46:43 DEBUG : file1.copy3.txt.5028a97.partial: renamed to: file1.copy3.txt 2025/04/08 05:46:43 INFO : file1.copy3.txt: Copied (new) 2025/04/08 05:46:43 DEBUG : file1.copy4.txt: md5 = d41d8cd98f00b204e9800998ecf8427e OK 2025/04/08 05:46:43 DEBUG : file1.copy4.txt.5028a97.partial: renamed to: file1.copy4.txt 2025/04/08 05:46:43 INFO : file1.copy4.txt: Copied (new) 2025/04/08 05:46:43 DEBUG : file1.copy5.txt: md5 = d41d8cd98f00b204e9800998ecf8427e OK 2025/04/08 05:46:43 DEBUG : file1.copy5.txt.5028a97.partial: renamed to: file1.copy5.txt 2025/04/08 05:46:43 INFO : file1.copy5.txt: Copied (new) 2025/04/08 05:46:43 DEBUG : file1.txt: md5 = d41d8cd98f00b204e9800998ecf8427e OK 2025/04/08 05:46:43 DEBUG : file1.txt.5028a97.partial: renamed to: file1.txt 2025/04/08 05:46:43 INFO : file1.txt: Copied (new) 2025/04/08 05:46:43 DEBUG : subdir/file20.txt: md5 = d41d8cd98f00b204e9800998ecf8427e OK 2025/04/08 05:46:43 DEBUG : subdir/file20.txt.5028a97.partial: renamed to: subdir/file20.txt 2025/04/08 05:46:43 INFO : subdir/file20.txt: Copied (new) 2025/04/08 05:46:43 DEBUG : file1.copy2.txt: md5 = d41d8cd98f00b204e9800998ecf8427e OK 2025/04/08 05:46:43 DEBUG : file1.copy2.txt.5028a97.partial: renamed to: file1.copy2.txt 2025/04/08 05:46:43 INFO : file1.copy2.txt: Copied (new) 2025/04/08 05:46:43 INFO : subdir: Set directory modification time (using SetModTime) 2025/04/08 05:46:45 ERROR : : error listing: directory not found 2025/04/08 05:46:45 NOTICE: checking initFs Local file system at /tmp/054641hu/initdir/test_all_changed-xobixuw1 2025/04/08 05:46:45 DEBUG : RCLONE_TEST: Need to transfer - File not found at Destination 2025/04/08 05:46:45 DEBUG : file1.copy1.txt: Need to transfer - File not found at Destination 2025/04/08 05:46:45 DEBUG : file1.copy2.txt: Need to transfer - File not found at Destination 2025/04/08 05:46:45 DEBUG : file1.copy3.txt: Need to transfer - File not found at Destination 2025/04/08 05:46:45 DEBUG : file1.copy4.txt: Need to transfer - File not found at Destination 2025/04/08 05:46:45 DEBUG : file1.copy5.txt: Need to transfer - File not found at Destination 2025/04/08 05:46:45 DEBUG : file1.txt: Need to transfer - File not found at Destination 2025/04/08 05:46:45 INFO : subdir: Making directory 2025/04/08 05:46:46 DEBUG : subdir/: Creating directory marker 2025/04/08 05:46:46 DEBUG : /: Creating directory marker 2025/04/08 05:46:46 DEBUG : subdir/file20.txt: Need to transfer - File not found at Destination 2025/04/08 05:46:46 DEBUG : GCS bucket rclone-test-hojucip4quro path 054641hu/all_changed/path1: Waiting for checks to finish 2025/04/08 05:46:46 DEBUG : GCS bucket rclone-test-hojucip4quro path 054641hu/all_changed/path1: Waiting for transfers to finish 2025/04/08 05:46:46 DEBUG : /: Creating directory marker 2025/04/08 05:46:47 DEBUG : RCLONE_TEST: md5 = 294d25b294ff26a5243dba914ac3fbf7 OK 2025/04/08 05:46:47 INFO : RCLONE_TEST: Copied (new) 2025/04/08 05:46:47 DEBUG : file1.copy3.txt: md5 = d41d8cd98f00b204e9800998ecf8427e OK 2025/04/08 05:46:47 INFO : file1.copy3.txt: Copied (new) 2025/04/08 05:46:47 DEBUG : file1.copy1.txt: md5 = d41d8cd98f00b204e9800998ecf8427e OK 2025/04/08 05:46:47 INFO : file1.copy1.txt: Copied (new) 2025/04/08 05:46:47 DEBUG : file1.copy2.txt: md5 = d41d8cd98f00b204e9800998ecf8427e OK 2025/04/08 05:46:47 INFO : file1.copy2.txt: Copied (new) 2025/04/08 05:46:48 DEBUG : file1.copy4.txt: md5 = d41d8cd98f00b204e9800998ecf8427e OK 2025/04/08 05:46:48 INFO : file1.copy4.txt: Copied (new) 2025/04/08 05:46:48 DEBUG : file1.txt: md5 = d41d8cd98f00b204e9800998ecf8427e OK 2025/04/08 05:46:48 INFO : file1.txt: Copied (new) 2025/04/08 05:46:48 DEBUG : file1.copy5.txt: md5 = d41d8cd98f00b204e9800998ecf8427e OK 2025/04/08 05:46:48 INFO : file1.copy5.txt: Copied (new) 2025/04/08 05:46:48 DEBUG : subdir/file20.txt: md5 = d41d8cd98f00b204e9800998ecf8427e OK 2025/04/08 05:46:48 INFO : subdir/file20.txt: Copied (new) 2025/04/08 05:46:48 NOTICE: checking Path1 GCS bucket rclone-test-hojucip4quro path 054641hu/all_changed/path1 --- FAIL: TestBisyncRemoteLocal (7.23s) --- FAIL: TestBisyncRemoteLocal/all_changed (7.23s) panic: runtime error: slice bounds out of range [27:26] [recovered] panic: runtime error: slice bounds out of range [27:26] goroutine 45 [running]: testing.tRunner.func1.2({0x24a4f80, 0xc000863050}) /home/rclone/go/pkg/mod/golang.org/toolchain@v0.0.1-go1.23.0.linux-amd64/src/testing/testing.go:1632 +0x230 testing.tRunner.func1() /home/rclone/go/pkg/mod/golang.org/toolchain@v0.0.1-go1.23.0.linux-amd64/src/testing/testing.go:1635 +0x35e panic({0x24a4f80?, 0xc000863050?}) /home/rclone/go/pkg/mod/golang.org/toolchain@v0.0.1-go1.23.0.linux-amd64/src/runtime/panic.go:785 +0x132 github.com/rclone/rclone/backend/googlecloudstorage.(*Fs).list(0xc000266640, {0x2aaca00, 0x3e4cf60}, {0xc000b16149, 0x18}, {0xc000b16162, 0x1a}, {0xc000b16162, 0x1a}, 0x0, ...) /home/rclone/go/src/github.com/rclone/rclone/backend/googlecloudstorage/googlecloudstorage.go:717 +0xffe github.com/rclone/rclone/backend/googlecloudstorage.(*Fs).ListR.func1({0xc000b16149?, 0x0?}, {0xc000b16162?, 0x47233d?}, {0xc000b16162?, 0x7f9e28f43a68?}, 0xa0?) /home/rclone/go/src/github.com/rclone/rclone/backend/googlecloudstorage/googlecloudstorage.go:850 +0x95 github.com/rclone/rclone/backend/googlecloudstorage.(*Fs).ListR(0xc000266640, {0x2aaca00, 0x3e4cf60}, {0x0?, 0x2572be0?}, 0xc0000be640) /home/rclone/go/src/github.com/rclone/rclone/backend/googlecloudstorage/googlecloudstorage.go:877 +0x12a github.com/rclone/rclone/fs/walk.listR({0x2aaca00, 0x3e4cf60}, {0x2ac2570, 0xc000266640}, {0x0, 0x0}, 0x1, 0x3, 0xc000924138, 0xc000a003f0, ...) /home/rclone/go/src/github.com/rclone/rclone/fs/walk/walk.go:298 +0x2a3 github.com/rclone/rclone/fs/walk.ListR({0x2aaca00, 0x3e4cf60}, {0x2ac2570, 0xc000266640}, {0x0, 0x0}, 0x1, 0xffffffffffffffff, 0x3, 0xc000924138) /home/rclone/go/src/github.com/rclone/rclone/fs/walk/walk.go:162 +0x1d5 github.com/rclone/rclone/fs/walk.GetAll({0x2aaca00, 0x3e4cf60}, {0x2ac2570, 0xc000266640}, {0x0, 0x0}, 0x1, 0xffffffffffffffff) /home/rclone/go/src/github.com/rclone/rclone/fs/walk/walk.go:631 +0x105 github.com/rclone/rclone/fstest.CheckListingWithRoot(0xc000423a00, {0x2ac2570, 0xc000266640}, {0x0, 0x0}, {0xc000866000, 0x8, 0x8}, {0xc000758de0, 0x1, ...}, ...) /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:274 +0x3d6 github.com/rclone/rclone/fstest.CheckListingWithPrecision(...) /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:332 github.com/rclone/rclone/cmd/bisync_test.(*bisyncTest).runTestCase(0xc0006a6540, {0x2aaca00, 0x3e4cf60}, 0x605?, {0xc000304b15?, 0x5599c0?}) /home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:460 +0xffb github.com/rclone/rclone/cmd/bisync_test.testBisync.func4(0xc000423a00) /home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:358 +0x234 testing.tRunner(0xc000423a00, 0xc0004ff380) /home/rclone/go/pkg/mod/golang.org/toolchain@v0.0.1-go1.23.0.linux-amd64/src/testing/testing.go:1690 +0xf4 created by testing.(*T).Run in goroutine 42 /home/rclone/go/pkg/mod/golang.org/toolchain@v0.0.1-go1.23.0.linux-amd64/src/testing/testing.go:1743 +0x390 "./bisync.test -test.v -test.timeout 1h0m0s -remote 'TestGoogleCloudStorage,directory_markers:' -verbose" - Finished ERROR in 7.297690876s (try 1/5): exit status 2: Failed [TestBisyncRemoteLocal/all_changed]