"./bisync.test -test.v -test.timeout 1h0m0s -remote 'TestAzureBlob,directory_markers:' -verbose" - Starting (try 1/5) 2025/03/15 07:49:36 DEBUG : Creating backend with remote "TestAzureBlob,directory_markers:rclone-test-macuvod3meyo" 2025/03/15 07:49:36 DEBUG : Using config file from "/home/rclone/.rclone.conf" 2025/03/15 07:49:36 DEBUG : TestAzureBlob: detected overridden config - adding "{juk_h}" suffix to name 2025/03/15 07:49:36 DEBUG : Azure container rclone-test-macuvod3meyo: Using directory markers 2025/03/15 07:49:36 DEBUG : Creating backend with remote "/tmp/rclone1146719966" === RUN TestBisyncRemoteLocal 2025/03/15 07:49:36 DEBUG : Creating backend with remote "TestAzureBlob,directory_markers:rclone-test-sojiyus0qodo" 2025/03/15 07:49:36 DEBUG : TestAzureBlob: detected overridden config - adding "{juk_h}" suffix to name 2025/03/15 07:49:36 DEBUG : Azure container rclone-test-sojiyus0qodo: Using directory markers 2025/03/15 07:49:36 NOTICE: remote: TestAzureBlob,directory_markers:rclone-test-sojiyus0qodo === RUN TestBisyncRemoteLocal/all_changed 2025/03/15 07:49:36 DEBUG : Creating backend with remote "TestAzureBlob,directory_markers:rclone-test-sojiyus0qodo/074936ku" 2025/03/15 07:49:36 DEBUG : Using config file from "/home/rclone/.rclone.conf" 2025/03/15 07:49:36 DEBUG : TestAzureBlob: detected overridden config - adding "{juk_h}" suffix to name 2025/03/15 07:49:36 DEBUG : Azure container rclone-test-sojiyus0qodo path 074936ku: Using directory markers 2025/03/15 07:49:36 DEBUG : fs cache: renaming cache item "TestAzureBlob,directory_markers:rclone-test-sojiyus0qodo/074936ku" to be canonical "TestAzureBlob{juk_h}:rclone-test-sojiyus0qodo/074936ku" 2025/03/15 07:49:36 INFO : path1: Making directory 2025/03/15 07:49:36 DEBUG : path1/: Creating directory marker 2025/03/15 07:49:36 DEBUG : Creating backend with remote "TestAzureBlob,directory_markers:rclone-test-sojiyus0qodo/074936ku/all_changed/path1" 2025/03/15 07:49:36 DEBUG : TestAzureBlob: detected overridden config - adding "{juk_h}" suffix to name 2025/03/15 07:49:36 DEBUG : Azure container rclone-test-sojiyus0qodo path 074936ku/all_changed/path1: Using directory markers 2025/03/15 07:49:36 DEBUG : fs cache: renaming cache item "TestAzureBlob,directory_markers:rclone-test-sojiyus0qodo/074936ku/all_changed/path1" to be canonical "TestAzureBlob{juk_h}:rclone-test-sojiyus0qodo/074936ku/all_changed/path1" 2025/03/15 07:49:36 DEBUG : Creating backend with remote "/tmp/074936ku" 2025/03/15 07:49:36 DEBUG : Creating backend with remote "/tmp/074936ku/all_changed/path2" 2025/03/15 07:49:36 DEBUG : Creating backend with remote "/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/testdata/test_all_changed/initial" 2025/03/15 07:49:36 DEBUG : Creating backend with remote "/tmp/074936ku/initdir/test_all_changed-tofewas1" 2025/03/15 07:49:36 DEBUG : RCLONE_TEST: Need to transfer - File not found at Destination 2025/03/15 07:49:36 DEBUG : file1.copy1.txt: Need to transfer - File not found at Destination 2025/03/15 07:49:36 DEBUG : file1.copy2.txt: Need to transfer - File not found at Destination 2025/03/15 07:49:36 DEBUG : file1.copy3.txt: Need to transfer - File not found at Destination 2025/03/15 07:49:36 DEBUG : file1.copy4.txt: Need to transfer - File not found at Destination 2025/03/15 07:49:36 DEBUG : file1.copy5.txt: Need to transfer - File not found at Destination 2025/03/15 07:49:36 DEBUG : file1.txt: Need to transfer - File not found at Destination 2025/03/15 07:49:36 DEBUG : subdir: Making directory with metadata 2025/03/15 07:49:36 INFO : subdir: Made directory with metadata (mtime=2021-11-02T05:00:07Z) 2025/03/15 07:49:36 DEBUG : Added delayed dir = "subdir", newDst=subdir 2025/03/15 07:49:36 DEBUG : subdir/file20.txt: Need to transfer - File not found at Destination 2025/03/15 07:49:36 DEBUG : Local file system at /tmp/074936ku/initdir/test_all_changed-tofewas1: Waiting for checks to finish 2025/03/15 07:49:36 DEBUG : Local file system at /tmp/074936ku/initdir/test_all_changed-tofewas1: Waiting for transfers to finish 2025/03/15 07:49:36 DEBUG : file1.copy1.txt: md5 = d41d8cd98f00b204e9800998ecf8427e OK 2025/03/15 07:49:36 DEBUG : file1.copy1.txt.5028a97.partial: renamed to: file1.copy1.txt 2025/03/15 07:49:36 INFO : file1.copy1.txt: Copied (new) 2025/03/15 07:49:36 DEBUG : file1.copy2.txt: md5 = d41d8cd98f00b204e9800998ecf8427e OK 2025/03/15 07:49:36 DEBUG : file1.copy2.txt.5028a97.partial: renamed to: file1.copy2.txt 2025/03/15 07:49:36 INFO : file1.copy2.txt: Copied (new) 2025/03/15 07:49:36 DEBUG : file1.copy3.txt: md5 = d41d8cd98f00b204e9800998ecf8427e OK 2025/03/15 07:49:36 DEBUG : file1.copy3.txt.5028a97.partial: renamed to: file1.copy3.txt 2025/03/15 07:49:36 INFO : file1.copy3.txt: Copied (new) 2025/03/15 07:49:36 DEBUG : file1.copy4.txt: md5 = d41d8cd98f00b204e9800998ecf8427e OK 2025/03/15 07:49:36 DEBUG : file1.copy4.txt.5028a97.partial: renamed to: file1.copy4.txt 2025/03/15 07:49:36 INFO : file1.copy4.txt: Copied (new) 2025/03/15 07:49:36 DEBUG : file1.copy5.txt: md5 = d41d8cd98f00b204e9800998ecf8427e OK 2025/03/15 07:49:36 DEBUG : file1.copy5.txt.5028a97.partial: renamed to: file1.copy5.txt 2025/03/15 07:49:36 INFO : file1.copy5.txt: Copied (new) 2025/03/15 07:49:36 DEBUG : file1.txt: md5 = d41d8cd98f00b204e9800998ecf8427e OK 2025/03/15 07:49:36 DEBUG : file1.txt.5028a97.partial: renamed to: file1.txt 2025/03/15 07:49:36 INFO : file1.txt: Copied (new) 2025/03/15 07:49:36 DEBUG : subdir/file20.txt: md5 = d41d8cd98f00b204e9800998ecf8427e OK 2025/03/15 07:49:36 DEBUG : subdir/file20.txt.5028a97.partial: renamed to: subdir/file20.txt 2025/03/15 07:49:36 INFO : subdir/file20.txt: Copied (new) 2025/03/15 07:49:36 DEBUG : RCLONE_TEST: md5 = 294d25b294ff26a5243dba914ac3fbf7 OK 2025/03/15 07:49:36 DEBUG : RCLONE_TEST.cf9a93ac.partial: renamed to: RCLONE_TEST 2025/03/15 07:49:36 INFO : RCLONE_TEST: Copied (new) 2025/03/15 07:49:36 INFO : subdir: Set directory modification time (using SetModTime) 2025/03/15 07:49:36 ERROR : : error listing: directory not found 2025/03/15 07:49:36 NOTICE: checking initFs Local file system at /tmp/074936ku/initdir/test_all_changed-tofewas1 2025/03/15 07:49:36 DEBUG : RCLONE_TEST: Need to transfer - File not found at Destination 2025/03/15 07:49:36 DEBUG : file1.copy1.txt: Need to transfer - File not found at Destination 2025/03/15 07:49:36 DEBUG : file1.copy2.txt: Need to transfer - File not found at Destination 2025/03/15 07:49:36 DEBUG : file1.copy3.txt: Need to transfer - File not found at Destination 2025/03/15 07:49:36 DEBUG : file1.copy4.txt: Need to transfer - File not found at Destination 2025/03/15 07:49:36 DEBUG : file1.copy5.txt: Need to transfer - File not found at Destination 2025/03/15 07:49:36 DEBUG : file1.txt: Need to transfer - File not found at Destination 2025/03/15 07:49:36 INFO : subdir: Making directory 2025/03/15 07:49:36 DEBUG : subdir/: Creating directory marker 2025/03/15 07:49:36 DEBUG : /: Creating directory marker 2025/03/15 07:49:37 DEBUG : /: Creating directory marker 2025/03/15 07:49:37 DEBUG : /: Creating directory marker 2025/03/15 07:49:37 DEBUG : /: Creating directory marker 2025/03/15 07:49:37 DEBUG : subdir/file20.txt: Need to transfer - File not found at Destination 2025/03/15 07:49:37 DEBUG : Azure container rclone-test-sojiyus0qodo path 074936ku/all_changed/path1: Waiting for checks to finish 2025/03/15 07:49:37 DEBUG : Azure container rclone-test-sojiyus0qodo path 074936ku/all_changed/path1: Waiting for transfers to finish 2025/03/15 07:49:37 DEBUG : file1.copy2.txt: md5 = d41d8cd98f00b204e9800998ecf8427e OK 2025/03/15 07:49:37 INFO : file1.copy2.txt: Copied (new) 2025/03/15 07:49:37 DEBUG : RCLONE_TEST: md5 = 294d25b294ff26a5243dba914ac3fbf7 OK 2025/03/15 07:49:37 INFO : RCLONE_TEST: Copied (new) 2025/03/15 07:49:37 DEBUG : file1.copy1.txt: md5 = d41d8cd98f00b204e9800998ecf8427e OK 2025/03/15 07:49:37 INFO : file1.copy1.txt: Copied (new) 2025/03/15 07:49:37 DEBUG : /: Creating directory marker 2025/03/15 07:49:37 DEBUG : file1.copy3.txt: md5 = d41d8cd98f00b204e9800998ecf8427e OK 2025/03/15 07:49:37 INFO : file1.copy3.txt: Copied (new) 2025/03/15 07:49:37 DEBUG : /: Creating directory marker 2025/03/15 07:49:37 DEBUG : /: Creating directory marker 2025/03/15 07:49:37 DEBUG : subdir/file20.txt: md5 = d41d8cd98f00b204e9800998ecf8427e OK 2025/03/15 07:49:37 INFO : subdir/file20.txt: Copied (new) 2025/03/15 07:49:37 DEBUG : file1.copy4.txt: md5 = d41d8cd98f00b204e9800998ecf8427e OK 2025/03/15 07:49:37 INFO : file1.copy4.txt: Copied (new) 2025/03/15 07:49:37 DEBUG : file1.txt: md5 = d41d8cd98f00b204e9800998ecf8427e OK 2025/03/15 07:49:37 INFO : file1.txt: Copied (new) 2025/03/15 07:49:37 DEBUG : file1.copy5.txt: md5 = d41d8cd98f00b204e9800998ecf8427e OK 2025/03/15 07:49:37 INFO : file1.copy5.txt: Copied (new) 2025/03/15 07:49:37 NOTICE: checking Path1 Azure container rclone-test-sojiyus0qodo path 074936ku/all_changed/path1 --- FAIL: TestBisyncRemoteLocal (1.26s) --- FAIL: TestBisyncRemoteLocal/all_changed (1.26s) panic: runtime error: slice bounds out of range [27:26] [recovered] panic: runtime error: slice bounds out of range [27:26] goroutine 40 [running]: testing.tRunner.func1.2({0x24a3ee0, 0xc0008aed98}) /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({0x24a3ee0?, 0xc0008aed98?}) /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/azureblob.(*Fs).list(0xc0006a5188, {0x2aab1a0, 0x3e4ad20}, {0xc0006e0920, 0x18}, {0xc0006e0939, 0x1a}, {0xc0006e0939, 0x1a}, 0x0, ...) /home/rclone/go/src/github.com/rclone/rclone/backend/azureblob/azureblob.go:1218 +0xc45 github.com/rclone/rclone/backend/azureblob.(*Fs).ListR.func1({0xc0006e0920?, 0xc0006e0920?}, {0xc0006e0939?, 0x10100000000?}, {0xc0006e0939?, 0x47233d?}, 0x0?) /home/rclone/go/src/github.com/rclone/rclone/backend/azureblob/azureblob.go:1383 +0xa5 github.com/rclone/rclone/backend/azureblob.(*Fs).ListR(0xc0006a5188, {0x2aab1a0, 0x3e4ad20}, {0x0?, 0x2571c40?}, 0xc00089e190) /home/rclone/go/src/github.com/rclone/rclone/backend/azureblob/azureblob.go:1413 +0x172 github.com/rclone/rclone/fs/walk.listR({0x2aab1a0, 0x3e4ad20}, {0x2abfe30, 0xc0006a5188}, {0x0, 0x0}, 0x1, 0x3, 0xc0009c8408, 0xc000acc7c8, ...) /home/rclone/go/src/github.com/rclone/rclone/fs/walk/walk.go:298 +0x2a3 github.com/rclone/rclone/fs/walk.ListR({0x2aab1a0, 0x3e4ad20}, {0x2abfe30, 0xc0006a5188}, {0x0, 0x0}, 0x1, 0xffffffffffffffff, 0x3, 0xc0009c8408) /home/rclone/go/src/github.com/rclone/rclone/fs/walk/walk.go:162 +0x1d5 github.com/rclone/rclone/fs/walk.GetAll({0x2aab1a0, 0x3e4ad20}, {0x2abfe30, 0xc0006a5188}, {0x0, 0x0}, 0x1, 0xffffffffffffffff) /home/rclone/go/src/github.com/rclone/rclone/fs/walk/walk.go:631 +0x105 github.com/rclone/rclone/fstest.CheckListingWithRoot(0xc000019040, {0x2abfe30, 0xc0006a5188}, {0x0, 0x0}, {0xc00039ba40, 0x8, 0x8}, {0xc00032f790, 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(0xc00052f500, {0x2aab1a0, 0x3e4ad20}, 0x605?, {0xc0006f5ff5?, 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(0xc000019040) /home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:358 +0x234 testing.tRunner(0xc000019040, 0xc0007d0c60) /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 37 /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 'TestAzureBlob,directory_markers:' -verbose" - Finished ERROR in 1.290880204s (try 1/5): exit status 2: Failed [TestBisyncRemoteLocal/all_changed]