"go test -v -timeout 1h0m0s -remote TestChunkerChunk50bYandex: -verbose -size-limit 1024 -test.run '^TestIntegration$/^FsMkdir$/^FsPutFiles$/^Internal$/^(BackwardsCompatibility|ChunkNumberOverflow|MetadataInput|PreventCorruption)$'" - Starting (try 2/5) === RUN TestIntegration fstests.go:438: Using remote "TestChunkerChunk50bYandex:" 2025/04/01 05:33:24 DEBUG : Creating backend with remote "TestChunkerChunk50bYandex:rclone-test-xoqugeq9taqa" 2025/04/01 05:33:24 DEBUG : Using config file from "/home/rclone/.rclone.conf" 2025/04/01 05:33:24 DEBUG : Creating backend with remote "TestYandex:rclone-test-xoqugeq9taqa" 2025/04/01 05:33:25 DEBUG : Reset feature "ListR" === RUN TestIntegration/FsMkdir === RUN TestIntegration/FsMkdir/FsPutFiles 2025/04/01 05:33:33 INFO : file name.txt.rclone_chunk.001_13plce: Moved (server-side) to: file name.txt.rclone_chunk.001 2025/04/01 05:33:34 INFO : file name.txt.rclone_chunk.002_13plce: Moved (server-side) to: file name.txt.rclone_chunk.002 2025/04/01 05:33:49 INFO : hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt.rclone_chunk.001_13pww6: Moved (server-side) to: hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt.rclone_chunk.001 2025/04/01 05:33:51 INFO : hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt.rclone_chunk.002_13pww6: Moved (server-side) to: hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt.rclone_chunk.002 2025/04/01 05:34:15 INFO : file name.txt.rclone_chunk.001_13qga5: Moved (server-side) to: file name.txt.rclone_chunk.001 2025/04/01 05:34:16 INFO : file name.txt.rclone_chunk.002_13qga5: Moved (server-side) to: file name.txt.rclone_chunk.002 === RUN TestIntegration/FsMkdir/FsPutFiles/Internal === RUN TestIntegration/FsMkdir/FsPutFiles/Internal/PreventCorruption 2025/04/01 05:34:34 INFO : corrupted/billy.rclone_chunk.001_13r3qy: Moved (server-side) to: corrupted/billy.rclone_chunk.001 2025/04/01 05:34:36 INFO : corrupted/billy.rclone_chunk.002_13r3qy: Moved (server-side) to: corrupted/billy.rclone_chunk.002 2025/04/01 05:34:38 INFO : corrupted/billy.rclone_chunk.003_13r3qy: Moved (server-side) to: corrupted/billy.rclone_chunk.003 2025/04/01 05:34:40 INFO : corrupted/billy.rclone_chunk.004_13r3qy: Moved (server-side) to: corrupted/billy.rclone_chunk.004 2025/04/01 05:34:42 INFO : corrupted/billy.rclone_chunk.005_13r3qy: Moved (server-side) to: corrupted/billy.rclone_chunk.005 2025/04/01 05:34:59 INFO : corrupted/silly1.rclone_chunk.001_13rs58: Moved (server-side) to: corrupted/silly1.rclone_chunk.001 2025/04/01 05:35:01 INFO : corrupted/silly1.rclone_chunk.002_13rs58: Moved (server-side) to: corrupted/silly1.rclone_chunk.002 2025/04/01 05:35:03 INFO : corrupted/silly1.rclone_chunk.003_13rs58: Moved (server-side) to: corrupted/silly1.rclone_chunk.003 2025/04/01 05:35:08 INFO : corrupted/silly1.rclone_chunk.004_13rs58: Moved (server-side) to: corrupted/silly1.rclone_chunk.004 2025/04/01 05:35:10 INFO : corrupted/silly1.rclone_chunk.005_13rs58: Moved (server-side) to: corrupted/silly1.rclone_chunk.005 2025/04/01 05:35:12 DEBUG : pacer: low level retry 1/10 (error [500 - InternalServerError] Internal Server Error (Ошибка сервера.)) 2025/04/01 05:35:12 DEBUG : pacer: Rate limited, increasing sleep to 20ms 2025/04/01 05:35:12 DEBUG : pacer: Reducing sleep to 15ms 2025/04/01 05:35:13 DEBUG : pacer: Reducing sleep to 11.25ms 2025/04/01 05:35:13 DEBUG : pacer: Reducing sleep to 10ms 2025/04/01 05:35:29 INFO : corrupted/silly2.rclone_chunk.001_13slwd: Moved (server-side) to: corrupted/silly2.rclone_chunk.001 2025/04/01 05:35:30 INFO : corrupted/silly2.rclone_chunk.002_13slwd: Moved (server-side) to: corrupted/silly2.rclone_chunk.002 2025/04/01 05:35:33 INFO : corrupted/silly2.rclone_chunk.003_13slwd: Moved (server-side) to: corrupted/silly2.rclone_chunk.003 2025/04/01 05:35:34 INFO : corrupted/silly2.rclone_chunk.004_13slwd: Moved (server-side) to: corrupted/silly2.rclone_chunk.004 2025/04/01 05:35:35 INFO : corrupted/silly2.rclone_chunk.005_13slwd: Moved (server-side) to: corrupted/silly2.rclone_chunk.005 2025/04/01 05:36:01 INFO : corrupted/silly3.rclone_chunk.001_13td6q: Moved (server-side) to: corrupted/silly3.rclone_chunk.001 2025/04/01 05:36:03 INFO : corrupted/silly3.rclone_chunk.002_13td6q: Moved (server-side) to: corrupted/silly3.rclone_chunk.002 2025/04/01 05:36:05 INFO : corrupted/silly3.rclone_chunk.003_13td6q: Moved (server-side) to: corrupted/silly3.rclone_chunk.003 2025/04/01 05:36:07 INFO : corrupted/silly3.rclone_chunk.004_13td6q: Moved (server-side) to: corrupted/silly3.rclone_chunk.004 2025/04/01 05:36:09 INFO : corrupted/silly3.rclone_chunk.005_13td6q: Moved (server-side) to: corrupted/silly3.rclone_chunk.005 2025/04/01 05:36:27 INFO : corrupted/willy.rclone_chunk.001_13u7g1: Moved (server-side) to: corrupted/willy.rclone_chunk.001 2025/04/01 05:36:28 INFO : corrupted/willy.rclone_chunk.002_13u7g1: Moved (server-side) to: corrupted/willy.rclone_chunk.002 2025/04/01 05:36:30 INFO : corrupted/willy.rclone_chunk.003_13u7g1: Moved (server-side) to: corrupted/willy.rclone_chunk.003 2025/04/01 05:36:31 INFO : corrupted/willy.rclone_chunk.004_13u7g1: Moved (server-side) to: corrupted/willy.rclone_chunk.004 2025/04/01 05:36:32 INFO : corrupted/willy.rclone_chunk.005_13u7g1: Moved (server-side) to: corrupted/willy.rclone_chunk.005 2025/04/01 05:36:59 INFO : corrupted/silly4.rclone_chunk.001_13uvqg: Moved (server-side) to: corrupted/silly4.rclone_chunk.001 2025/04/01 05:37:01 INFO : corrupted/silly4.rclone_chunk.002_13uvqg: Moved (server-side) to: corrupted/silly4.rclone_chunk.002 2025/04/01 05:37:03 INFO : corrupted/silly4.rclone_chunk.003_13uvqg: Moved (server-side) to: corrupted/silly4.rclone_chunk.003 2025/04/01 05:37:04 INFO : corrupted/silly4.rclone_chunk.004_13uvqg: Moved (server-side) to: corrupted/silly4.rclone_chunk.004 2025/04/01 05:37:06 INFO : corrupted/silly4.rclone_chunk.005_13uvqg: Moved (server-side) to: corrupted/silly4.rclone_chunk.005 2025/04/01 05:37:10 ERROR : corrupted/silly4: Failed to copy: can't copy: chunk overlap with "corrupted/willy" 2025/04/01 05:37:25 INFO : corrupted/silly5.rclone_chunk.001_13vtcz: Moved (server-side) to: corrupted/silly5.rclone_chunk.001 2025/04/01 05:37:26 INFO : corrupted/silly5.rclone_chunk.002_13vtcz: Moved (server-side) to: corrupted/silly5.rclone_chunk.002 2025/04/01 05:37:28 INFO : corrupted/silly5.rclone_chunk.003_13vtcz: Moved (server-side) to: corrupted/silly5.rclone_chunk.003 2025/04/01 05:37:29 INFO : corrupted/silly5.rclone_chunk.004_13vtcz: Moved (server-side) to: corrupted/silly5.rclone_chunk.004 2025/04/01 05:37:31 INFO : corrupted/silly5.rclone_chunk.005_13vtcz: Moved (server-side) to: corrupted/silly5.rclone_chunk.005 2025/04/01 05:37:40 ERROR : corrupted/willy.rclone_chunk.002: Couldn't delete: refuse to corrupt: chunk overlap with "corrupted/willy" === RUN TestIntegration/FsMkdir/FsPutFiles/Internal/ChunkNumberOverflow 2025/04/01 05:38:27 INFO : wreaked/wreaker.rclone_chunk.001_13xq88: Moved (server-side) to: wreaked/wreaker.rclone_chunk.001 2025/04/01 05:38:30 INFO : wreaked/wreaker.rclone_chunk.002_13xq88: Moved (server-side) to: wreaked/wreaker.rclone_chunk.002 2025/04/01 05:38:37 DEBUG : Chunked 'TestChunkerChunk50bYandex:rclone-test-xoqugeq9taqa': invalid directory entry "wreaked/wreaker" === RUN TestIntegration/FsMkdir/FsPutFiles/Internal/MetadataInput 2025/04/01 05:39:06 ERROR : usermeta/today.rclone_chunk.001_13yw5h: Couldn't move: couldn't move file: [409 - DiskResourceAlreadyExistsError] Resource "disk:/rclone-test-xoqugeq9taqa/usermeta/today.rclone_chunk.001" already exists. (Ресурс "disk:/rclone-test-xoqugeq9taqa/usermeta/today.rclone_chunk.001" уже существует.) 2025/04/01 05:39:10 INFO : usermeta/today.rclone_chunk.001: Deleted 2025/04/01 05:39:12 INFO : usermeta/today.rclone_chunk.001_13yw5h: Moved (server-side) to: usermeta/today.rclone_chunk.001 2025/04/01 05:39:34 ERROR : usermeta/past.rclone_chunk.001_13znye: Couldn't move: couldn't move file: [409 - DiskResourceAlreadyExistsError] Resource "disk:/rclone-test-xoqugeq9taqa/usermeta/past.rclone_chunk.001" already exists. (Ресурс "disk:/rclone-test-xoqugeq9taqa/usermeta/past.rclone_chunk.001" уже существует.) 2025/04/01 05:39:38 INFO : usermeta/past.rclone_chunk.001: Deleted 2025/04/01 05:39:39 INFO : usermeta/past.rclone_chunk.001_13znye: Moved (server-side) to: usermeta/past.rclone_chunk.001 2025/04/01 05:40:02 ERROR : usermeta/future.rclone_chunk.001_140f15: Couldn't move: couldn't move file: [409 - DiskResourceAlreadyExistsError] Resource "disk:/rclone-test-xoqugeq9taqa/usermeta/future.rclone_chunk.001" already exists. (Ресурс "disk:/rclone-test-xoqugeq9taqa/usermeta/future.rclone_chunk.001" уже существует.) 2025/04/01 05:40:06 INFO : usermeta/future.rclone_chunk.001: Deleted 2025/04/01 05:40:08 INFO : usermeta/future.rclone_chunk.001_140f15: Moved (server-side) to: usermeta/future.rclone_chunk.001 === RUN TestIntegration/FsMkdir/FsPutFiles/Internal/BackwardsCompatibility 2025/04/01 05:40:57 DEBUG : pacer: low level retry 1/10 (error [500 - InternalServerError] Internal Server Error (Ошибка сервера.)) 2025/04/01 05:40:57 DEBUG : pacer: Rate limited, increasing sleep to 20ms 2025/04/01 05:40:57 DEBUG : pacer: Reducing sleep to 15ms 2025/04/01 05:40:58 DEBUG : pacer: Reducing sleep to 11.25ms 2025/04/01 05:40:58 DEBUG : pacer: Reducing sleep to 10ms 2025/04/01 05:41:03 DEBUG : pacer: low level retry 1/10 (error [500 - InternalServerError] Internal Server Error (Ошибка сервера.)) 2025/04/01 05:41:03 DEBUG : pacer: Rate limited, increasing sleep to 20ms 2025/04/01 05:41:03 DEBUG : pacer: Reducing sleep to 15ms 2025/04/01 05:41:04 DEBUG : pacer: Reducing sleep to 11.25ms 2025/04/01 05:41:04 DEBUG : pacer: Reducing sleep to 10ms 2025/04/01 05:41:26 INFO : backcomp/renamefile.rclone_chunk.001_1418f0: Moved (server-side) to: backcomp/renamefile.rclone_chunk.001 2025/04/01 05:41:30 INFO : backcomp/renamefile.rclone_chunk.002_1418f0: Moved (server-side) to: backcomp/renamefile.rclone_chunk.002 2025/04/01 05:41:32 INFO : backcomp/renamefile.rclone_chunk.003_1418f0: Moved (server-side) to: backcomp/renamefile.rclone_chunk.003 2025/04/01 05:41:34 INFO : backcomp/renamefile.rclone_chunk.004_1418f0: Moved (server-side) to: backcomp/renamefile.rclone_chunk.004 2025/04/01 05:41:35 INFO : backcomp/renamefile.rclone_chunk.005_1418f0: Moved (server-side) to: backcomp/renamefile.rclone_chunk.005 2025/04/01 05:41:37 INFO : backcomp/renamefile.rclone_chunk.006_1418f0: Moved (server-side) to: backcomp/renamefile.rclone_chunk.006 2025/04/01 05:41:39 INFO : backcomp/renamefile.rclone_chunk.007_1418f0: Moved (server-side) to: backcomp/renamefile.rclone_chunk.007 2025/04/01 05:41:40 INFO : backcomp/renamefile.rclone_chunk.008_1418f0: Moved (server-side) to: backcomp/renamefile.rclone_chunk.008 2025/04/01 05:41:43 INFO : backcomp/renamefile.rclone_chunk.009_1418f0: Moved (server-side) to: backcomp/renamefile.rclone_chunk.009 2025/04/01 05:41:44 INFO : backcomp/renamefile.rclone_chunk.010_1418f0: Moved (server-side) to: backcomp/renamefile.rclone_chunk.010 2025/04/01 05:41:46 INFO : backcomp/renamefile.rclone_chunk.011_1418f0: Moved (server-side) to: backcomp/renamefile.rclone_chunk.011 2025/04/01 05:41:47 INFO : backcomp/renamefile.rclone_chunk.012_1418f0: Moved (server-side) to: backcomp/renamefile.rclone_chunk.012 2025/04/01 05:41:49 INFO : backcomp/renamefile.rclone_chunk.013_1418f0: Moved (server-side) to: backcomp/renamefile.rclone_chunk.013 2025/04/01 05:41:51 INFO : backcomp/renamefile.rclone_chunk.014_1418f0: Moved (server-side) to: backcomp/renamefile.rclone_chunk.014 2025/04/01 05:41:52 INFO : backcomp/renamefile.rclone_chunk.015_1418f0: Moved (server-side) to: backcomp/renamefile.rclone_chunk.015 2025/04/01 05:41:53 INFO : backcomp/renamefile.rclone_chunk.016_1418f0: Moved (server-side) to: backcomp/renamefile.rclone_chunk.016 2025/04/01 05:41:54 INFO : backcomp/renamefile.rclone_chunk.017_1418f0: Moved (server-side) to: backcomp/renamefile.rclone_chunk.017 2025/04/01 05:41:56 INFO : backcomp/renamefile.rclone_chunk.018_1418f0: Moved (server-side) to: backcomp/renamefile.rclone_chunk.018 2025/04/01 05:41:58 INFO : backcomp/renamefile.rclone_chunk.019_1418f0: Moved (server-side) to: backcomp/renamefile.rclone_chunk.019 2025/04/01 05:41:59 INFO : backcomp/renamefile.rclone_chunk.020_1418f0: Moved (server-side) to: backcomp/renamefile.rclone_chunk.020 2025/04/01 05:42:01 INFO : backcomp/renamefile.rclone_chunk.021_1418f0: Moved (server-side) to: backcomp/renamefile.rclone_chunk.021 2025/04/01 05:42:03 INFO : backcomp/renamefile.rclone_chunk.022_1418f0: Moved (server-side) to: backcomp/renamefile.rclone_chunk.022 2025/04/01 05:42:05 INFO : backcomp/renamefile.rclone_chunk.023_1418f0: Moved (server-side) to: backcomp/renamefile.rclone_chunk.023 2025/04/01 05:42:06 INFO : backcomp/renamefile.rclone_chunk.024_1418f0: Moved (server-side) to: backcomp/renamefile.rclone_chunk.024 2025/04/01 05:42:08 INFO : backcomp/renamefile.rclone_chunk.025_1418f0: Moved (server-side) to: backcomp/renamefile.rclone_chunk.025 fstest.go:121: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:121 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:126 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:145 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:199 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:209 /home/rclone/go/src/github.com/rclone/rclone/backend/chunker/chunker_internal_test.go:793 /home/rclone/go/src/github.com/rclone/rclone/backend/chunker/chunker_internal_test.go:800 /home/rclone/go/src/github.com/rclone/rclone/backend/chunker/chunker_internal_test.go:929 Error: Should be true Test: TestIntegration/FsMkdir/FsPutFiles/Internal/BackwardsCompatibility Messages: backcomp/renamefile: Modification time difference too big |-211753h37m2.500000001s| > 1ns (want 2001-02-03 04:05:06.499999999 +0000 UTC vs got 2025-04-01 05:42:09 +0000 UTC) (precision 1ns) fstest.go:121: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:121 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:126 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:145 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:202 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstests/fstests.go:209 /home/rclone/go/src/github.com/rclone/rclone/backend/chunker/chunker_internal_test.go:793 /home/rclone/go/src/github.com/rclone/rclone/backend/chunker/chunker_internal_test.go:800 /home/rclone/go/src/github.com/rclone/rclone/backend/chunker/chunker_internal_test.go:929 Error: Should be true Test: TestIntegration/FsMkdir/FsPutFiles/Internal/BackwardsCompatibility Messages: backcomp/renamefile: Modification time difference too big |-211753h37m2.500000001s| > 1ns (want 2001-02-03 04:05:06.499999999 +0000 UTC vs got 2025-04-01 05:42:09 +0000 UTC) (precision 1ns) fstest.go:121: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:121 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:126 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:145 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:189 /home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:302 /home/rclone/go/src/github.com/rclone/rclone/backend/chunker/chunker_internal_test.go:809 /home/rclone/go/src/github.com/rclone/rclone/backend/chunker/chunker_internal_test.go:929 Error: Should be true Test: TestIntegration/FsMkdir/FsPutFiles/Internal/BackwardsCompatibility Messages: backcomp/renamefile: Modification time difference too big |-211753h37m2.500000001s| > 1ns (want 2001-02-03 04:05:06.499999999 +0000 UTC vs got 2025-04-01 05:42:09 +0000 UTC) (precision 1ns) 2025/04/01 05:44:11 ERROR : : error listing: directory not found === NAME TestIntegration/FsMkdir fstests.go:2817: Warning: this should produce fs.ErrorDirNotFound --- FAIL: TestIntegration (647.03s) --- FAIL: TestIntegration/FsMkdir (645.69s) --- FAIL: TestIntegration/FsMkdir/FsPutFiles (633.35s) --- FAIL: TestIntegration/FsMkdir/FsPutFiles/Internal (579.08s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/Internal/PreventCorruption (238.75s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/Internal/ChunkNumberOverflow (39.98s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/Internal/MetadataInput (86.38s) --- FAIL: TestIntegration/FsMkdir/FsPutFiles/Internal/BackwardsCompatibility (213.97s) FAIL exit status 1 FAIL github.com/rclone/rclone/backend/chunker 647.093s "go test -v -timeout 1h0m0s -remote TestChunkerChunk50bYandex: -verbose -size-limit 1024 -test.run '^TestIntegration$/^FsMkdir$/^FsPutFiles$/^Internal$/^(BackwardsCompatibility|ChunkNumberOverflow|MetadataInput|PreventCorruption)$'" - Finished ERROR in 10m50.087417352s (try 2/5): exit status 1: Failed [TestIntegration/FsMkdir/FsPutFiles/Internal/BackwardsCompatibility]