"./sync.test -test.v -test.timeout 1h0m0s -remote TestB2: -list-retries 5 -verbose" - Starting (try 1/5) 2022/01/13 05:08:44 DEBUG : Creating backend with remote "TestB2:rclone-test-gatazem7gokizuc4mixileb1" 2022/01/13 05:08:44 DEBUG : Using config file from "/home/rclone/.rclone.conf" 2022/01/13 05:08:45 DEBUG : Creating backend with remote "/tmp/rclone2735015204" === RUN TestPipe --- PASS: TestPipe (0.00s) === RUN TestPipeConcurrent --- PASS: TestPipeConcurrent (0.02s) === RUN TestPipeOrderBy === RUN TestPipeOrderBy/#00 === RUN TestPipeOrderBy/size === RUN TestPipeOrderBy/name === RUN TestPipeOrderBy/modtime === RUN TestPipeOrderBy/size,ascending === RUN TestPipeOrderBy/name,asc === RUN TestPipeOrderBy/modtime,ascending === RUN TestPipeOrderBy/size,descending === RUN TestPipeOrderBy/name,desc === RUN TestPipeOrderBy/modtime,descending === RUN TestPipeOrderBy/size,mixed,50 === RUN TestPipeOrderBy/size,mixed,51 --- PASS: TestPipeOrderBy (0.00s) --- PASS: TestPipeOrderBy/#00 (0.00s) --- PASS: TestPipeOrderBy/size (0.00s) --- PASS: TestPipeOrderBy/name (0.00s) --- PASS: TestPipeOrderBy/modtime (0.00s) --- PASS: TestPipeOrderBy/size,ascending (0.00s) --- PASS: TestPipeOrderBy/name,asc (0.00s) --- PASS: TestPipeOrderBy/modtime,ascending (0.00s) --- PASS: TestPipeOrderBy/size,descending (0.00s) --- PASS: TestPipeOrderBy/name,desc (0.00s) --- PASS: TestPipeOrderBy/modtime,descending (0.00s) --- PASS: TestPipeOrderBy/size,mixed,50 (0.00s) --- PASS: TestPipeOrderBy/size,mixed,51 (0.00s) === RUN TestNewLess === RUN TestNewLess/blankOK === RUN TestNewLess/tooManyParts === RUN TestNewLess/tooManyParts2 === RUN TestNewLess/badMixed === RUN TestNewLess/unknownComparison === RUN TestNewLess/unknownSortDirection === RUN TestNewLess/size === RUN TestNewLess/name === RUN TestNewLess/modtime === RUN TestNewLess/size,ascending === RUN TestNewLess/name,asc === RUN TestNewLess/modtime,ascending === RUN TestNewLess/size,descending === RUN TestNewLess/name,desc === RUN TestNewLess/modtime,descending === RUN TestNewLess/modtime,mixed === RUN TestNewLess/modtime,mixed,30 --- PASS: TestNewLess (0.00s) --- PASS: TestNewLess/blankOK (0.00s) --- PASS: TestNewLess/tooManyParts (0.00s) --- PASS: TestNewLess/tooManyParts2 (0.00s) --- PASS: TestNewLess/badMixed (0.00s) --- PASS: TestNewLess/unknownComparison (0.00s) --- PASS: TestNewLess/unknownSortDirection (0.00s) --- PASS: TestNewLess/size (0.00s) --- PASS: TestNewLess/name (0.00s) --- PASS: TestNewLess/modtime (0.00s) --- PASS: TestNewLess/size,ascending (0.00s) --- PASS: TestNewLess/name,asc (0.00s) --- PASS: TestNewLess/modtime,ascending (0.00s) --- PASS: TestNewLess/size,descending (0.00s) --- PASS: TestNewLess/name,desc (0.00s) --- PASS: TestNewLess/modtime,descending (0.00s) --- PASS: TestNewLess/modtime,mixed (0.00s) --- PASS: TestNewLess/modtime,mixed,30 (0.00s) === RUN TestRcCopy rc_test.go:16: Skipping test on non local remote --- SKIP: TestRcCopy (0.00s) === RUN TestRcMove rc_test.go:16: Skipping test on non local remote --- SKIP: TestRcMove (0.00s) === RUN TestRcSync rc_test.go:16: Skipping test on non local remote --- SKIP: TestRcSync (0.00s) === RUN TestCopyWithDryRun run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:08:46 NOTICE: sub dir/hello world: Skipped copy as --dry-run is set (size 11) 2022/01/13 05:08:46 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:08:46 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish --- PASS: TestCopyWithDryRun (1.62s) === RUN TestCopy run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:08:46 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:08:46 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:08:48 DEBUG : sub dir/hello world: sha1 = 2aae6c35c94fcfb415dbe95f408b9ce91ee846ed OK 2022/01/13 05:08:48 INFO : sub dir/hello world: Copied (new) --- PASS: TestCopy (2.40s) === RUN TestCopyMissingDirectory run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:08:49 DEBUG : Creating backend with remote "/non-existing" 2022/01/13 05:08:49 ERROR : Local file system at /non-existing: error reading source root directory: directory not found 2022/01/13 05:08:49 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:08:49 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish --- PASS: TestCopyMissingDirectory (0.51s) === RUN TestCopyNoTraverse run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:08:50 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:08:50 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:08:50 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:08:51 DEBUG : sub dir/hello world: sha1 = 2aae6c35c94fcfb415dbe95f408b9ce91ee846ed OK 2022/01/13 05:08:51 INFO : sub dir/hello world: Copied (new) --- PASS: TestCopyNoTraverse (2.57s) === RUN TestCopyCheckFirst run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:08:52 INFO : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Running all checks before starting transfers 2022/01/13 05:08:52 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:08:52 INFO : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Checks finished, now starting transfers 2022/01/13 05:08:52 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:08:52 DEBUG : sub dir/hello world: sha1 = 2aae6c35c94fcfb415dbe95f408b9ce91ee846ed OK 2022/01/13 05:08:52 INFO : sub dir/hello world: Copied (new) --- PASS: TestCopyCheckFirst (1.72s) === RUN TestSyncNoTraverse run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:08:53 ERROR : Ignoring --no-traverse with sync 2022/01/13 05:08:54 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:08:54 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:08:56 DEBUG : sub dir/hello world: sha1 = 2aae6c35c94fcfb415dbe95f408b9ce91ee846ed OK 2022/01/13 05:08:56 INFO : sub dir/hello world: Copied (new) 2022/01/13 05:08:56 DEBUG : Waiting for deletions to finish --- PASS: TestSyncNoTraverse (3.74s) === RUN TestCopyWithDepth run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:08:57 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:08:57 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:08:58 DEBUG : hello world2: sha1 = c0bf117f9c93d02c894fe8ffd6e5cecf3545c209 OK 2022/01/13 05:08:58 INFO : hello world2: Copied (new) --- PASS: TestCopyWithDepth (2.51s) === RUN TestCopyWithFilesFrom run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:09:00 DEBUG : hello world2: Excluded 2022/01/13 05:09:00 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:09:00 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:09:00 DEBUG : potato2: sha1 = 2aae6c35c94fcfb415dbe95f408b9ce91ee846ed OK 2022/01/13 05:09:00 INFO : potato2: Copied (new) --- PASS: TestCopyWithFilesFrom (1.53s) === RUN TestCopyWithFilesFromAndNoTraverse run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:09:02 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:09:02 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:09:02 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:09:03 DEBUG : potato2: sha1 = 2aae6c35c94fcfb415dbe95f408b9ce91ee846ed OK 2022/01/13 05:09:03 INFO : potato2: Copied (new) --- PASS: TestCopyWithFilesFromAndNoTraverse (2.41s) === RUN TestCopyEmptyDirectories run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:09:04 DEBUG : sub dir2: Making directory 2022/01/13 05:09:04 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:09:04 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:09:04 DEBUG : sub dir/hello world: sha1 = 2aae6c35c94fcfb415dbe95f408b9ce91ee846ed OK 2022/01/13 05:09:04 INFO : sub dir/hello world: Copied (new) 2022/01/13 05:09:04 DEBUG : sub dir2: Making directory 2022/01/13 05:09:04 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: copied 1 directories fstest.go:251: Filtering empty directory "sub dir2" --- PASS: TestCopyEmptyDirectories (1.60s) === RUN TestMoveEmptyDirectories run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:09:05 DEBUG : sub dir2: Making directory 2022/01/13 05:09:05 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:09:05 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:09:06 DEBUG : sub dir/hello world: sha1 = 2aae6c35c94fcfb415dbe95f408b9ce91ee846ed OK 2022/01/13 05:09:06 INFO : sub dir/hello world: Copied (new) 2022/01/13 05:09:06 INFO : sub dir/hello world: Deleted 2022/01/13 05:09:06 DEBUG : sub dir: Making directory 2022/01/13 05:09:06 DEBUG : sub dir2: Making directory 2022/01/13 05:09:06 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: copied 2 directories fstest.go:251: Filtering empty directory "sub dir2" --- PASS: TestMoveEmptyDirectories (2.50s) === RUN TestSyncEmptyDirectories run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:09:08 DEBUG : sub dir2: Making directory 2022/01/13 05:09:08 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:09:08 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:09:08 DEBUG : sub dir/hello world: sha1 = 2aae6c35c94fcfb415dbe95f408b9ce91ee846ed OK 2022/01/13 05:09:08 INFO : sub dir/hello world: Copied (new) 2022/01/13 05:09:08 DEBUG : sub dir2: Making directory 2022/01/13 05:09:08 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: copied 1 directories 2022/01/13 05:09:08 DEBUG : Waiting for deletions to finish fstest.go:251: Filtering empty directory "sub dir2" --- PASS: TestSyncEmptyDirectories (1.63s) === RUN TestServerSideCopy run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:09:10 DEBUG : Creating backend with remote "TestB2:rclone-test-yivihoq3hafuhuj5baqacak0" sync_test.go:275: Server side copy (if possible) B2 bucket rclone-test-gatazem7gokizuc4mixileb1 -> B2 bucket rclone-test-yivihoq3hafuhuj5baqacak0 2022/01/13 05:09:11 DEBUG : B2 bucket rclone-test-yivihoq3hafuhuj5baqacak0: Waiting for checks to finish 2022/01/13 05:09:11 DEBUG : B2 bucket rclone-test-yivihoq3hafuhuj5baqacak0: Waiting for transfers to finish 2022/01/13 05:09:13 DEBUG : sub dir/hello world: sha1 = 2aae6c35c94fcfb415dbe95f408b9ce91ee846ed OK 2022/01/13 05:09:13 INFO : sub dir/hello world: Copied (server-side copy) 2022/01/13 05:09:13 DEBUG : B2 bucket rclone-test-yivihoq3hafuhuj5baqacak0: Purge remote 2022/01/13 05:09:13 DEBUG : sub dir/hello world: Deleting (id "4_z8ff20d03d07d5b1b7fe80e1b_f102b96b8782def11_d20220113_m050912_c001_v0001015_t0032") --- PASS: TestServerSideCopy (5.20s) === RUN TestCopyAfterDelete run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:09:15 ERROR : : error listing: directory not found 2022/01/13 05:09:15 DEBUG : Local file system at /tmp/rclone2735015204: Making directory 2022/01/13 05:09:16 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:09:16 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish --- PASS: TestCopyAfterDelete (1.97s) === RUN TestCopyRedownload run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:09:18 DEBUG : Local file system at /tmp/rclone2735015204: Waiting for checks to finish 2022/01/13 05:09:18 DEBUG : Local file system at /tmp/rclone2735015204: Waiting for transfers to finish 2022/01/13 05:09:18 DEBUG : sub dir/hello world: sha1 = 2aae6c35c94fcfb415dbe95f408b9ce91ee846ed OK 2022/01/13 05:09:18 INFO : sub dir/hello world: Copied (new) --- PASS: TestCopyRedownload (2.46s) === RUN TestSyncBasedOnCheckSum run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:09:19 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:09:19 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:09:20 DEBUG : check sum: sha1 = 3bc15c8aae3e4124dd409035f32ea2fd6835efc9 OK 2022/01/13 05:09:20 INFO : check sum: Copied (new) 2022/01/13 05:09:20 DEBUG : Waiting for deletions to finish 2022/01/13 05:09:20 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:09:20 DEBUG : check sum: sha1 = 3bc15c8aae3e4124dd409035f32ea2fd6835efc9 OK 2022/01/13 05:09:20 DEBUG : check sum: Size and sha1 of src and dst objects identical 2022/01/13 05:09:20 DEBUG : check sum: Unchanged skipping 2022/01/13 05:09:20 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:09:20 DEBUG : Waiting for deletions to finish 2022/01/13 05:09:20 INFO : There was nothing to transfer --- PASS: TestSyncBasedOnCheckSum (2.12s) === RUN TestSyncSizeOnly run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:09:21 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:09:21 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:09:22 DEBUG : sizeonly: sha1 = 3e2e95f5ad970eadfa7e17eaf73da97024aa5359 OK 2022/01/13 05:09:22 INFO : sizeonly: Copied (new) 2022/01/13 05:09:22 DEBUG : Waiting for deletions to finish 2022/01/13 05:09:22 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:09:22 DEBUG : sizeonly: Sizes identical 2022/01/13 05:09:22 DEBUG : sizeonly: Unchanged skipping 2022/01/13 05:09:22 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:09:22 DEBUG : Waiting for deletions to finish 2022/01/13 05:09:22 INFO : There was nothing to transfer --- PASS: TestSyncSizeOnly (1.88s) === RUN TestSyncIgnoreSize run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:09:23 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:09:23 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:09:24 DEBUG : ignore-size: sha1 = 4a756ca07e9487f482465a99e8286abc86ba4dc7 OK 2022/01/13 05:09:24 INFO : ignore-size: Copied (new) 2022/01/13 05:09:24 DEBUG : Waiting for deletions to finish 2022/01/13 05:09:24 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:09:24 DEBUG : ignore-size: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:09:24 DEBUG : ignore-size: Unchanged skipping 2022/01/13 05:09:24 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:09:24 DEBUG : Waiting for deletions to finish 2022/01/13 05:09:24 INFO : There was nothing to transfer --- PASS: TestSyncIgnoreSize (3.15s) === RUN TestSyncIgnoreTimes run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:09:27 DEBUG : existing: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:09:27 DEBUG : existing: Unchanged skipping 2022/01/13 05:09:27 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:09:27 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:09:27 DEBUG : Waiting for deletions to finish 2022/01/13 05:09:27 INFO : There was nothing to transfer 2022/01/13 05:09:27 DEBUG : existing: Transferring unconditionally as --ignore-times is in use 2022/01/13 05:09:27 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:09:27 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:09:28 DEBUG : existing: sha1 = 3e2e95f5ad970eadfa7e17eaf73da97024aa5359 OK 2022/01/13 05:09:28 INFO : existing: Copied (replaced existing) 2022/01/13 05:09:28 DEBUG : Waiting for deletions to finish --- PASS: TestSyncIgnoreTimes (3.52s) === RUN TestSyncIgnoreExisting run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:09:30 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:09:30 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:09:31 DEBUG : existing: sha1 = 3e2e95f5ad970eadfa7e17eaf73da97024aa5359 OK 2022/01/13 05:09:31 INFO : existing: Copied (new) 2022/01/13 05:09:31 DEBUG : Waiting for deletions to finish 2022/01/13 05:09:31 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:09:31 DEBUG : existing: Destination exists, skipping 2022/01/13 05:09:31 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:09:31 DEBUG : Waiting for deletions to finish 2022/01/13 05:09:31 INFO : There was nothing to transfer --- PASS: TestSyncIgnoreExisting (2.90s) === RUN TestSyncIgnoreErrors run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:09:34 DEBUG : d: Making directory fstest.go:251: Filtering empty directory "d" 2022/01/13 05:09:34 DEBUG : c/non empty space: Size and modification time the same (differ by -456.789µs, within tolerance 1ms) 2022/01/13 05:09:34 DEBUG : c/non empty space: Unchanged skipping 2022/01/13 05:09:34 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:09:34 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:09:36 DEBUG : a/potato2: sha1 = 9dc7f7d3279715991a22853f5981df582b7f9f6d OK 2022/01/13 05:09:36 INFO : a/potato2: Copied (new) 2022/01/13 05:09:36 DEBUG : Waiting for deletions to finish 2022/01/13 05:09:37 INFO : b/potato: Deleted --- PASS: TestSyncIgnoreErrors (5.82s) === RUN TestSyncAfterChangingModtimeOnly run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:09:39 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:09:39 DEBUG : empty space: Modification times differ by -95456h54m52.624456789s: 2011-12-25 12:59:59.123456789 +0000 UTC, 2001-02-03 04:05:06.499 +0000 UTC 2022/01/13 05:09:39 DEBUG : empty space: sha1 = 3bc15c8aae3e4124dd409035f32ea2fd6835efc9 OK 2022/01/13 05:09:39 NOTICE: empty space: Skipped update modification time as --dry-run is set (size 1) 2022/01/13 05:09:39 DEBUG : empty space: Unchanged skipping 2022/01/13 05:09:39 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:09:39 DEBUG : Waiting for deletions to finish 2022/01/13 05:09:39 INFO : There was nothing to transfer 2022/01/13 05:09:40 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:09:40 DEBUG : empty space: Modification times differ by -95456h54m52.624456789s: 2011-12-25 12:59:59.123456789 +0000 UTC, 2001-02-03 04:05:06.499 +0000 UTC 2022/01/13 05:09:40 DEBUG : empty space: sha1 = 3bc15c8aae3e4124dd409035f32ea2fd6835efc9 OK 2022/01/13 05:09:41 INFO : empty space: Updated modification time in destination 2022/01/13 05:09:41 DEBUG : empty space: Unchanged skipping 2022/01/13 05:09:41 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:09:41 DEBUG : Waiting for deletions to finish 2022/01/13 05:09:41 INFO : There was nothing to transfer --- PASS: TestSyncAfterChangingModtimeOnly (3.94s) === RUN TestSyncAfterChangingModtimeOnlyWithNoUpdateModTime run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:09:43 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:09:43 DEBUG : empty space: Modification times differ by -95456h54m52.624456789s: 2011-12-25 12:59:59.123456789 +0000 UTC, 2001-02-03 04:05:06.499 +0000 UTC 2022/01/13 05:09:43 DEBUG : empty space: sha1 = 3bc15c8aae3e4124dd409035f32ea2fd6835efc9 OK 2022/01/13 05:09:43 DEBUG : empty space: Unchanged skipping 2022/01/13 05:09:43 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:09:43 DEBUG : Waiting for deletions to finish 2022/01/13 05:09:43 INFO : There was nothing to transfer --- PASS: TestSyncAfterChangingModtimeOnlyWithNoUpdateModTime (2.26s) === RUN TestSyncDoesntUpdateModtime run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:09:45 DEBUG : foo: Modification times differ by -95456h54m52.624456789s: 2011-12-25 12:59:59.123456789 +0000 UTC, 2001-02-03 04:05:06.499 +0000 UTC 2022/01/13 05:09:45 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:09:45 DEBUG : foo: sha1 = 0beec7b5ea3f0fdbc95d0dd47f3c5bc275da8a33 (Local file system at /tmp/rclone2735015204) 2022/01/13 05:09:45 DEBUG : foo: sha1 = 62cdb7020ff920e5aa642c3d4066950dd1f01f4d (B2 bucket rclone-test-gatazem7gokizuc4mixileb1) 2022/01/13 05:09:45 DEBUG : foo: sha1 differ 2022/01/13 05:09:45 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:09:46 DEBUG : foo: sha1 = 0beec7b5ea3f0fdbc95d0dd47f3c5bc275da8a33 OK 2022/01/13 05:09:46 INFO : foo: Copied (replaced existing) 2022/01/13 05:09:46 DEBUG : Waiting for deletions to finish --- PASS: TestSyncDoesntUpdateModtime (2.69s) === RUN TestSyncAfterAddingAFile run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:09:48 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:09:48 DEBUG : empty space: Size and modification time the same (differ by -456.789µs, within tolerance 1ms) 2022/01/13 05:09:48 DEBUG : empty space: Unchanged skipping 2022/01/13 05:09:48 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:09:49 DEBUG : potato: sha1 = 9dc7f7d3279715991a22853f5981df582b7f9f6d OK 2022/01/13 05:09:49 INFO : potato: Copied (new) 2022/01/13 05:09:49 DEBUG : Waiting for deletions to finish --- PASS: TestSyncAfterAddingAFile (8.11s) === RUN TestSyncAfterChangingFilesSizeOnly run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:09:57 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:09:57 DEBUG : potato: Sizes differ (src 21 vs dst 60) 2022/01/13 05:09:57 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:09:57 DEBUG : potato: sha1 = 0fd321a1023ac4e1e1054fcc0236b9d0755f722f OK 2022/01/13 05:09:57 INFO : potato: Copied (replaced existing) 2022/01/13 05:09:57 DEBUG : Waiting for deletions to finish --- PASS: TestSyncAfterChangingFilesSizeOnly (3.36s) === RUN TestSyncAfterChangingContentsOnly run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:10:00 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:10:00 DEBUG : potato: Modification times differ by 119h59m59.876543211s: 2011-12-25 12:59:59.123456789 +0000 UTC, 2011-12-30 12:59:59 +0000 UTC 2022/01/13 05:10:00 DEBUG : potato: sha1 = 1ca5094b3b73f587249eabe179c40a3eec839b1f (Local file system at /tmp/rclone2735015204) 2022/01/13 05:10:00 DEBUG : potato: sha1 = 0fd321a1023ac4e1e1054fcc0236b9d0755f722f (B2 bucket rclone-test-gatazem7gokizuc4mixileb1) 2022/01/13 05:10:00 DEBUG : potato: sha1 differ 2022/01/13 05:10:00 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:10:03 DEBUG : potato: sha1 = 1ca5094b3b73f587249eabe179c40a3eec839b1f OK 2022/01/13 05:10:03 INFO : potato: Copied (replaced existing) 2022/01/13 05:10:03 DEBUG : Waiting for deletions to finish --- PASS: TestSyncAfterChangingContentsOnly (5.50s) === RUN TestSyncAfterRemovingAFileAndAddingAFileDryRun run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:10:06 NOTICE: potato2: Skipped copy as --dry-run is set (size 60) 2022/01/13 05:10:06 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:10:06 DEBUG : empty space: Size and modification time the same (differ by -456.789µs, within tolerance 1ms) 2022/01/13 05:10:06 DEBUG : empty space: Unchanged skipping 2022/01/13 05:10:06 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:10:06 DEBUG : Waiting for deletions to finish 2022/01/13 05:10:06 NOTICE: potato: Skipped delete as --dry-run is set (size 21) --- PASS: TestSyncAfterRemovingAFileAndAddingAFileDryRun (2.88s) === RUN TestSyncAfterRemovingAFileAndAddingAFile run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:10:08 DEBUG : empty space: Size and modification time the same (differ by -456.789µs, within tolerance 1ms) 2022/01/13 05:10:08 DEBUG : empty space: Unchanged skipping 2022/01/13 05:10:08 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:10:08 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:10:09 DEBUG : potato2: sha1 = 9dc7f7d3279715991a22853f5981df582b7f9f6d OK 2022/01/13 05:10:09 INFO : potato2: Copied (new) 2022/01/13 05:10:09 DEBUG : Waiting for deletions to finish 2022/01/13 05:10:10 INFO : potato: Deleted --- PASS: TestSyncAfterRemovingAFileAndAddingAFile (5.92s) === RUN TestSyncAfterRemovingAFileAndAddingAFileSubDir run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:10:15 DEBUG : d: Making directory 2022/01/13 05:10:15 DEBUG : d/e: Making directory fstest.go:251: Filtering empty directory "d" fstest.go:251: Filtering empty directory "d/e" 2022/01/13 05:10:15 DEBUG : c/non empty space: Size and modification time the same (differ by -456.789µs, within tolerance 1ms) 2022/01/13 05:10:15 DEBUG : c/non empty space: Unchanged skipping 2022/01/13 05:10:15 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:10:15 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:10:17 DEBUG : a/potato2: sha1 = 9dc7f7d3279715991a22853f5981df582b7f9f6d OK 2022/01/13 05:10:17 INFO : a/potato2: Copied (new) 2022/01/13 05:10:17 DEBUG : Waiting for deletions to finish 2022/01/13 05:10:17 INFO : b/potato: Deleted --- PASS: TestSyncAfterRemovingAFileAndAddingAFileSubDir (7.15s) === RUN TestSyncAfterRemovingAFileAndAddingAFileSubDirWithErrors run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:10:22 DEBUG : d: Making directory fstest.go:251: Filtering empty directory "d" 2022/01/13 05:10:22 DEBUG : c/non empty space: Size and modification time the same (differ by -456.789µs, within tolerance 1ms) 2022/01/13 05:10:22 DEBUG : c/non empty space: Unchanged skipping 2022/01/13 05:10:23 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:10:23 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:10:23 DEBUG : a/potato2: sha1 = 9dc7f7d3279715991a22853f5981df582b7f9f6d OK 2022/01/13 05:10:23 INFO : a/potato2: Copied (new) 2022/01/13 05:10:23 ERROR : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: not deleting files as there were IO errors 2022/01/13 05:10:23 ERROR : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: not deleting directories as there were IO errors fstest.go:251: Filtering empty directory "d" --- PASS: TestSyncAfterRemovingAFileAndAddingAFileSubDirWithErrors (4.94s) === RUN TestSyncDeleteAfter --- PASS: TestSyncDeleteAfter (0.00s) === RUN TestSyncDeleteDuring run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:10:26 DEBUG : Waiting for deletions to finish 2022/01/13 05:10:27 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:10:27 DEBUG : empty space: Size and modification time the same (differ by -456.789µs, within tolerance 1ms) 2022/01/13 05:10:27 DEBUG : empty space: Unchanged skipping 2022/01/13 05:10:27 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:10:27 DEBUG : potato2: sha1 = 9dc7f7d3279715991a22853f5981df582b7f9f6d OK 2022/01/13 05:10:27 INFO : potato2: Copied (new) 2022/01/13 05:10:27 INFO : potato: Deleted --- PASS: TestSyncDeleteDuring (3.72s) === RUN TestSyncDeleteBefore run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:10:37 DEBUG : Waiting for deletions to finish 2022/01/13 05:10:37 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:10:37 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:10:37 INFO : potato: Deleted 2022/01/13 05:10:37 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:10:37 DEBUG : empty space: Size and modification time the same (differ by -456.789µs, within tolerance 1ms) 2022/01/13 05:10:37 DEBUG : empty space: Unchanged skipping 2022/01/13 05:10:37 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:10:38 DEBUG : potato2: sha1 = 9dc7f7d3279715991a22853f5981df582b7f9f6d OK 2022/01/13 05:10:38 INFO : potato2: Copied (new) --- PASS: TestSyncDeleteBefore (11.73s) === RUN TestCopyDeleteBefore run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:10:41 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:10:41 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:10:42 DEBUG : potato2: sha1 = 810274f0df19dab60a894a562b7a8ff04c072623 OK 2022/01/13 05:10:42 INFO : potato2: Copied (new) --- PASS: TestCopyDeleteBefore (3.40s) === RUN TestSyncWithExclude run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:10:45 DEBUG : enormous: Excluded 2022/01/13 05:10:45 DEBUG : potato2: Excluded 2022/01/13 05:10:46 DEBUG : potato2: Excluded 2022/01/13 05:10:46 DEBUG : empty space: Size and modification time the same (differ by -456.789µs, within tolerance 1ms) 2022/01/13 05:10:46 DEBUG : empty space: Unchanged skipping 2022/01/13 05:10:46 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:10:46 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:10:46 DEBUG : Waiting for deletions to finish 2022/01/13 05:10:46 INFO : There was nothing to transfer 2022/01/13 05:10:46 DEBUG : enormous: Excluded 2022/01/13 05:10:46 DEBUG : potato2: Excluded 2022/01/13 05:10:46 DEBUG : potato2: Excluded 2022/01/13 05:10:46 DEBUG : empty space: Size and modification time the same (differ by 456.789µs, within tolerance 1ms) 2022/01/13 05:10:46 DEBUG : empty space: Unchanged skipping 2022/01/13 05:10:46 DEBUG : Local file system at /tmp/rclone2735015204: Waiting for checks to finish 2022/01/13 05:10:46 DEBUG : Local file system at /tmp/rclone2735015204: Waiting for transfers to finish 2022/01/13 05:10:46 DEBUG : Waiting for deletions to finish 2022/01/13 05:10:46 INFO : There was nothing to transfer --- PASS: TestSyncWithExclude (3.81s) === RUN TestSyncWithExcludeAndDeleteExcluded run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:10:50 DEBUG : enormous: Excluded 2022/01/13 05:10:50 DEBUG : potato2: Excluded 2022/01/13 05:10:50 DEBUG : empty space: Size and modification time the same (differ by -456.789µs, within tolerance 1ms) 2022/01/13 05:10:50 DEBUG : empty space: Unchanged skipping 2022/01/13 05:10:50 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:10:50 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:10:50 DEBUG : Waiting for deletions to finish 2022/01/13 05:10:51 INFO : enormous: Deleted 2022/01/13 05:10:51 INFO : potato2: Deleted 2022/01/13 05:10:51 INFO : There was nothing to transfer 2022/01/13 05:10:51 DEBUG : Local file system at /tmp/rclone2735015204: Waiting for checks to finish 2022/01/13 05:10:51 DEBUG : empty space: Size and modification time the same (differ by 456.789µs, within tolerance 1ms) 2022/01/13 05:10:51 DEBUG : empty space: Unchanged skipping 2022/01/13 05:10:51 DEBUG : Local file system at /tmp/rclone2735015204: Waiting for transfers to finish 2022/01/13 05:10:51 DEBUG : Waiting for deletions to finish 2022/01/13 05:10:51 INFO : enormous: Deleted 2022/01/13 05:10:51 INFO : potato2: Deleted 2022/01/13 05:10:51 INFO : There was nothing to transfer --- PASS: TestSyncWithExcludeAndDeleteExcluded (4.18s) === RUN TestSyncWithUpdateOlder run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:10:57 DEBUG : four: Sizes differ (src 4 vs dst 8) 2022/01/13 05:10:57 DEBUG : four: Destination mod time is within 1s of source but files differ, transferring 2022/01/13 05:10:57 DEBUG : one: Destination is newer than source, skipping 2022/01/13 05:10:57 DEBUG : three: Sizes identical 2022/01/13 05:10:57 DEBUG : three: Destination mod time is within 1s of source and files identical, skipping 2022/01/13 05:10:57 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:10:57 DEBUG : two: sha1 = ad782ecdac770fc6eb9a62e44f90873fb97fb26b (Local file system at /tmp/rclone2735015204) 2022/01/13 05:10:57 DEBUG : two: sha1 = b10e0da85e90399abfec36c7376b20aa4596461b (B2 bucket rclone-test-gatazem7gokizuc4mixileb1) 2022/01/13 05:10:57 DEBUG : two: sha1 differ 2022/01/13 05:10:57 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:10:58 DEBUG : two: sha1 = ad782ecdac770fc6eb9a62e44f90873fb97fb26b OK 2022/01/13 05:10:58 INFO : two: Copied (replaced existing) 2022/01/13 05:10:59 DEBUG : five: sha1 = 4db2c1df4610cd6c0da6b9197b066bfb4e9b9d00 OK 2022/01/13 05:10:59 INFO : five: Copied (new) 2022/01/13 05:10:59 DEBUG : four: sha1 = 9f8f7eec5dea5ac43738721939c120318cbff1df OK 2022/01/13 05:10:59 INFO : four: Copied (replaced existing) 2022/01/13 05:10:59 DEBUG : Waiting for deletions to finish 2022/01/13 05:10:59 DEBUG : one: Destination is newer than source, skipping 2022/01/13 05:10:59 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:10:59 DEBUG : four: sha1 = 9f8f7eec5dea5ac43738721939c120318cbff1df OK 2022/01/13 05:10:59 DEBUG : four: Size and sha1 of src and dst objects identical 2022/01/13 05:10:59 DEBUG : four: Destination mod time is within 1s of source and files identical, skipping 2022/01/13 05:10:59 DEBUG : five: sha1 = 4db2c1df4610cd6c0da6b9197b066bfb4e9b9d00 OK 2022/01/13 05:10:59 DEBUG : five: Size and sha1 of src and dst objects identical 2022/01/13 05:10:59 DEBUG : five: Destination mod time is within 1s of source and files identical, skipping 2022/01/13 05:10:59 DEBUG : two: sha1 = ad782ecdac770fc6eb9a62e44f90873fb97fb26b OK 2022/01/13 05:10:59 DEBUG : two: Size and sha1 of src and dst objects identical 2022/01/13 05:10:59 DEBUG : two: Destination mod time is within 1s of source and files identical, skipping 2022/01/13 05:10:59 DEBUG : three: sha1 = b802f384302cb24fbab0a44997e820bf2e8507bb (Local file system at /tmp/rclone2735015204) 2022/01/13 05:10:59 DEBUG : three: sha1 = 03731cad13f4cf7b59703c77529381cdec1632e5 (B2 bucket rclone-test-gatazem7gokizuc4mixileb1) 2022/01/13 05:10:59 DEBUG : three: sha1 differ 2022/01/13 05:10:59 DEBUG : three: Destination mod time is within 1s of source but files differ, transferring 2022/01/13 05:10:59 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:11:00 DEBUG : three: sha1 = b802f384302cb24fbab0a44997e820bf2e8507bb OK 2022/01/13 05:11:00 INFO : three: Copied (replaced existing) 2022/01/13 05:11:00 DEBUG : Waiting for deletions to finish --- PASS: TestSyncWithUpdateOlder (12.72s) === RUN TestSyncWithMaxDuration sync_test.go:1009: Skipping test on non local remote --- SKIP: TestSyncWithMaxDuration (0.00s) === RUN TestSyncWithTrackRenames run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" sync_test.go:1058: Can track renames: true 2022/01/13 05:11:05 INFO : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Making map for --track-renames 2022/01/13 05:11:05 INFO : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Finished making map for --track-renames 2022/01/13 05:11:05 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:11:05 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for renames to finish 2022/01/13 05:11:05 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:11:06 DEBUG : potato: sha1 = 1d1ac61cfffcfdd0a15cc9ae575fb06ca8c11fb5 OK 2022/01/13 05:11:06 INFO : potato: Copied (new) 2022/01/13 05:11:06 DEBUG : yam: sha1 = ad84b2fb6729688a5ee3225164a6d4d58465b33e OK 2022/01/13 05:11:06 INFO : yam: Copied (new) 2022/01/13 05:11:06 DEBUG : Waiting for deletions to finish 2022/01/13 05:11:07 INFO : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Making map for --track-renames 2022/01/13 05:11:07 DEBUG : potato: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:11:07 DEBUG : potato: Unchanged skipping 2022/01/13 05:11:07 INFO : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Finished making map for --track-renames 2022/01/13 05:11:07 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:11:07 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for renames to finish 2022/01/13 05:11:07 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:11:08 DEBUG : yam: sha1 = ad84b2fb6729688a5ee3225164a6d4d58465b33e OK 2022/01/13 05:11:08 INFO : yam: Copied (server-side copy) to: yaml 2022/01/13 05:11:09 INFO : yam: Deleted 2022/01/13 05:11:09 INFO : yaml: Renamed from "yam" 2022/01/13 05:11:09 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:11:09 DEBUG : Waiting for deletions to finish --- PASS: TestSyncWithTrackRenames (6.19s) === RUN TestParseRenamesStrategyModtime --- PASS: TestParseRenamesStrategyModtime (0.00s) === RUN TestRenamesStrategyModtime --- PASS: TestRenamesStrategyModtime (0.00s) === RUN TestSyncWithTrackRenamesStrategyModtime run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" sync_test.go:1127: Can track renames: true 2022/01/13 05:11:11 INFO : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Making map for --track-renames 2022/01/13 05:11:11 INFO : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Finished making map for --track-renames 2022/01/13 05:11:11 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:11:11 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for renames to finish 2022/01/13 05:11:11 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:11:12 DEBUG : yam: sha1 = ad84b2fb6729688a5ee3225164a6d4d58465b33e OK 2022/01/13 05:11:12 INFO : yam: Copied (new) 2022/01/13 05:11:12 DEBUG : potato: sha1 = 1d1ac61cfffcfdd0a15cc9ae575fb06ca8c11fb5 OK 2022/01/13 05:11:12 INFO : potato: Copied (new) 2022/01/13 05:11:12 DEBUG : Waiting for deletions to finish 2022/01/13 05:11:12 DEBUG : potato: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:11:12 DEBUG : potato: Unchanged skipping 2022/01/13 05:11:12 INFO : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Making map for --track-renames 2022/01/13 05:11:12 INFO : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Finished making map for --track-renames 2022/01/13 05:11:12 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:11:12 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for renames to finish 2022/01/13 05:11:13 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:11:14 DEBUG : yam: sha1 = ad84b2fb6729688a5ee3225164a6d4d58465b33e OK 2022/01/13 05:11:14 INFO : yam: Copied (server-side copy) to: yaml 2022/01/13 05:11:15 INFO : yam: Deleted 2022/01/13 05:11:15 INFO : yaml: Renamed from "yam" 2022/01/13 05:11:15 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:11:15 DEBUG : Waiting for deletions to finish --- PASS: TestSyncWithTrackRenamesStrategyModtime (5.81s) === RUN TestSyncWithTrackRenamesStrategyLeaf run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" sync_test.go:1163: Can track renames: true 2022/01/13 05:11:17 INFO : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Making map for --track-renames 2022/01/13 05:11:17 INFO : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Finished making map for --track-renames 2022/01/13 05:11:17 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:11:17 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for renames to finish 2022/01/13 05:11:17 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:11:18 DEBUG : sub/yam: sha1 = ad84b2fb6729688a5ee3225164a6d4d58465b33e OK 2022/01/13 05:11:18 INFO : sub/yam: Copied (new) 2022/01/13 05:11:18 DEBUG : potato: sha1 = 1d1ac61cfffcfdd0a15cc9ae575fb06ca8c11fb5 OK 2022/01/13 05:11:18 INFO : potato: Copied (new) 2022/01/13 05:11:18 DEBUG : Waiting for deletions to finish 2022/01/13 05:11:18 DEBUG : potato: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:11:18 DEBUG : potato: Unchanged skipping 2022/01/13 05:11:19 INFO : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Making map for --track-renames 2022/01/13 05:11:19 INFO : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Finished making map for --track-renames 2022/01/13 05:11:19 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:11:19 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for renames to finish 2022/01/13 05:11:19 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:11:20 DEBUG : sub/yam: sha1 = ad84b2fb6729688a5ee3225164a6d4d58465b33e OK 2022/01/13 05:11:20 INFO : sub/yam: Copied (server-side copy) to: yam 2022/01/13 05:11:21 INFO : sub/yam: Deleted 2022/01/13 05:11:21 INFO : yam: Renamed from "sub/yam" 2022/01/13 05:11:21 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:11:21 DEBUG : Waiting for deletions to finish --- PASS: TestSyncWithTrackRenamesStrategyLeaf (10.10s) === RUN TestMoveWithDeleteEmptySrcDirs run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:11:27 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:11:27 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:11:28 DEBUG : nested/sub dir/file: sha1 = b4b3e0a278988bc15f2913af3f4153ccef74e465 OK 2022/01/13 05:11:28 INFO : nested/sub dir/file: Copied (new) 2022/01/13 05:11:28 INFO : nested/sub dir/file: Deleted 2022/01/13 05:11:29 DEBUG : sub dir/hello world: sha1 = 2aae6c35c94fcfb415dbe95f408b9ce91ee846ed OK 2022/01/13 05:11:29 INFO : sub dir/hello world: Copied (new) 2022/01/13 05:11:29 INFO : sub dir/hello world: Deleted 2022/01/13 05:11:29 INFO : sub dir: Removing directory 2022/01/13 05:11:29 INFO : nested/sub dir: Removing directory 2022/01/13 05:11:29 INFO : nested: Removing directory 2022/01/13 05:11:29 DEBUG : Local file system at /tmp/rclone2735015204: deleted 3 directories --- PASS: TestMoveWithDeleteEmptySrcDirs (3.22s) === RUN TestMoveWithoutDeleteEmptySrcDirs run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:11:30 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:11:30 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:11:31 DEBUG : nested/sub dir/file: sha1 = b4b3e0a278988bc15f2913af3f4153ccef74e465 OK 2022/01/13 05:11:31 INFO : nested/sub dir/file: Copied (new) 2022/01/13 05:11:31 INFO : nested/sub dir/file: Deleted 2022/01/13 05:11:32 DEBUG : sub dir/hello world: sha1 = 2aae6c35c94fcfb415dbe95f408b9ce91ee846ed OK 2022/01/13 05:11:32 INFO : sub dir/hello world: Copied (new) 2022/01/13 05:11:32 INFO : sub dir/hello world: Deleted --- PASS: TestMoveWithoutDeleteEmptySrcDirs (3.25s) === RUN TestMoveWithIgnoreExisting run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:11:33 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:11:33 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:11:34 DEBUG : existing: sha1 = 3e2e95f5ad970eadfa7e17eaf73da97024aa5359 OK 2022/01/13 05:11:34 INFO : existing: Copied (new) 2022/01/13 05:11:34 INFO : existing: Deleted 2022/01/13 05:11:34 DEBUG : existing-b: sha1 = 321f6b7e8bf7f29aab89c5e41a555b1b0baa41a9 OK 2022/01/13 05:11:34 INFO : existing-b: Copied (new) 2022/01/13 05:11:34 INFO : existing-b: Deleted 2022/01/13 05:11:35 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:11:35 DEBUG : existing: Destination exists, skipping 2022/01/13 05:11:35 DEBUG : existing: Not removing source file as destination file exists and --ignore-existing is set 2022/01/13 05:11:35 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:11:35 INFO : There was nothing to transfer --- PASS: TestMoveWithIgnoreExisting (3.17s) === RUN TestServerSideMove run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:11:36 DEBUG : Creating backend with remote "TestB2:rclone-test-runoxux8qagebid6yekozil8" sync_test.go:1215: Server side move (if possible) B2 bucket rclone-test-gatazem7gokizuc4mixileb1 -> B2 bucket rclone-test-runoxux8qagebid6yekozil8 2022/01/13 05:11:44 DEBUG : empty space: Size and modification time the same (differ by 0s, within tolerance 1ms) 2022/01/13 05:11:44 DEBUG : empty space: Unchanged skipping 2022/01/13 05:11:44 DEBUG : potato3: Sizes differ (src 68 vs dst 60) 2022/01/13 05:11:44 DEBUG : B2 bucket rclone-test-runoxux8qagebid6yekozil8: Waiting for checks to finish 2022/01/13 05:11:45 DEBUG : potato2: sha1 = 9dc7f7d3279715991a22853f5981df582b7f9f6d OK 2022/01/13 05:11:45 INFO : potato2: Copied (server-side copy) 2022/01/13 05:11:45 INFO : potato2: Deleted 2022/01/13 05:11:45 INFO : empty space: Deleted 2022/01/13 05:11:45 DEBUG : B2 bucket rclone-test-runoxux8qagebid6yekozil8: Waiting for transfers to finish 2022/01/13 05:11:46 DEBUG : potato3: sha1 = 568f8850f3c1a384731dbe40c6d72e1dcae342a0 OK 2022/01/13 05:11:46 INFO : potato3: Copied (server-side copy) 2022/01/13 05:11:46 INFO : potato3: Deleted 2022/01/13 05:11:47 DEBUG : Creating backend with remote "TestB2:rclone-test-yakujaw4sazoxaq9vagefip6" 2022/01/13 05:11:48 DEBUG : B2 bucket rclone-test-yakujaw4sazoxaq9vagefip6: Waiting for checks to finish 2022/01/13 05:11:48 DEBUG : B2 bucket rclone-test-yakujaw4sazoxaq9vagefip6: Waiting for transfers to finish 2022/01/13 05:11:48 DEBUG : empty space: sha1 = 3bc15c8aae3e4124dd409035f32ea2fd6835efc9 OK 2022/01/13 05:11:48 INFO : empty space: Copied (server-side copy) 2022/01/13 05:11:49 DEBUG : potato3: sha1 = 568f8850f3c1a384731dbe40c6d72e1dcae342a0 OK 2022/01/13 05:11:49 INFO : potato3: Copied (server-side copy) 2022/01/13 05:11:49 INFO : empty space: Deleted 2022/01/13 05:11:49 INFO : potato3: Deleted 2022/01/13 05:11:49 DEBUG : potato2: sha1 = 9dc7f7d3279715991a22853f5981df582b7f9f6d OK 2022/01/13 05:11:49 INFO : potato2: Copied (server-side copy) 2022/01/13 05:11:50 INFO : potato2: Deleted 2022/01/13 05:11:50 DEBUG : B2 bucket rclone-test-yakujaw4sazoxaq9vagefip6: Purge remote 2022/01/13 05:11:51 DEBUG : empty space: Deleting (id "4_z7f026d33d09d5b1b7fe80e1b_f117560ca827a6d27_d20220113_m051148_c001_v0001153_t0022") 2022/01/13 05:11:51 DEBUG : potato2: Deleting (id "4_z7f026d33d09d5b1b7fe80e1b_f11600f323f8739d7_d20220113_m051148_c001_v0001105_t0053") 2022/01/13 05:11:51 DEBUG : potato3: Deleting (id "4_z7f026d33d09d5b1b7fe80e1b_f105439af185d05a8_d20220113_m051148_c001_v0001137_t0023") 2022/01/13 05:11:51 DEBUG : B2 bucket rclone-test-runoxux8qagebid6yekozil8: Purge remote 2022/01/13 05:11:52 DEBUG : empty space: Deleting (id "4_z4f124d33d09d5b1b7fe80e1b_f106eb339080a7dfb_d20220113_m051148_c001_v0001109_t0025") 2022/01/13 05:11:52 DEBUG : empty space: Deleting (id "4_z4f124d33d09d5b1b7fe80e1b_f103f7b04232cebf3_d20220113_m051141_c001_v0001041_t0046") 2022/01/13 05:11:52 DEBUG : potato2: Deleting (id "4_z4f124d33d09d5b1b7fe80e1b_f108e73366934f455_d20220113_m051149_c001_v0001134_t0011") 2022/01/13 05:11:52 DEBUG : potato2: Deleting (id "4_z4f124d33d09d5b1b7fe80e1b_f111c179e1ac6d84f_d20220113_m051144_c001_v0001093_t0012") 2022/01/13 05:11:52 DEBUG : potato3: Deleting (id "4_z4f124d33d09d5b1b7fe80e1b_f10200b2bb88fb5ad_d20220113_m051149_c001_v0001161_t0005") 2022/01/13 05:11:52 DEBUG : potato3: Deleting (id "4_z4f124d33d09d5b1b7fe80e1b_f110ba2daac9e2f90_d20220113_m051145_c001_v0001136_t0018") 2022/01/13 05:11:52 DEBUG : potato3: Deleting (id "4_z4f124d33d09d5b1b7fe80e1b_f103f7b04232cec00_d20220113_m051143_c001_v0001041_t0004") --- PASS: TestServerSideMove (16.35s) === RUN TestServerSideMoveWithFilter run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:11:53 DEBUG : Creating backend with remote "TestB2:rclone-test-bovurab8xujefet3hequpuv9" sync_test.go:1215: Server side move (if possible) B2 bucket rclone-test-gatazem7gokizuc4mixileb1 -> B2 bucket rclone-test-bovurab8xujefet3hequpuv9 2022/01/13 05:12:02 DEBUG : empty space: Excluded 2022/01/13 05:12:03 DEBUG : empty space: Excluded 2022/01/13 05:12:03 DEBUG : potato3: Sizes differ (src 68 vs dst 60) 2022/01/13 05:12:03 DEBUG : B2 bucket rclone-test-bovurab8xujefet3hequpuv9: Waiting for checks to finish 2022/01/13 05:12:03 DEBUG : B2 bucket rclone-test-bovurab8xujefet3hequpuv9: Waiting for transfers to finish 2022/01/13 05:12:03 DEBUG : potato3: sha1 = 568f8850f3c1a384731dbe40c6d72e1dcae342a0 OK 2022/01/13 05:12:03 INFO : potato3: Copied (server-side copy) 2022/01/13 05:12:03 DEBUG : potato2: sha1 = 9dc7f7d3279715991a22853f5981df582b7f9f6d OK 2022/01/13 05:12:03 INFO : potato2: Copied (server-side copy) 2022/01/13 05:12:04 INFO : potato3: Deleted 2022/01/13 05:12:04 INFO : potato2: Deleted 2022/01/13 05:12:04 DEBUG : Creating backend with remote "TestB2:rclone-test-zufolej1xajuguv5cafoyop7" 2022/01/13 05:12:05 DEBUG : empty space: Excluded 2022/01/13 05:12:05 DEBUG : B2 bucket rclone-test-zufolej1xajuguv5cafoyop7: Waiting for checks to finish 2022/01/13 05:12:05 DEBUG : B2 bucket rclone-test-zufolej1xajuguv5cafoyop7: Waiting for transfers to finish 2022/01/13 05:12:06 DEBUG : potato2: sha1 = 9dc7f7d3279715991a22853f5981df582b7f9f6d OK 2022/01/13 05:12:06 INFO : potato2: Copied (server-side copy) 2022/01/13 05:12:07 DEBUG : potato3: sha1 = 568f8850f3c1a384731dbe40c6d72e1dcae342a0 OK 2022/01/13 05:12:07 INFO : potato3: Copied (server-side copy) 2022/01/13 05:12:07 INFO : potato2: Deleted 2022/01/13 05:12:08 INFO : potato3: Deleted 2022/01/13 05:12:08 DEBUG : B2 bucket rclone-test-zufolej1xajuguv5cafoyop7: Purge remote 2022/01/13 05:12:08 DEBUG : potato2: Deleting (id "4_z2f02ad83d09d5b1b7fe80e1b_f1009758cd73577bc_d20220113_m051206_c001_v0001033_t0000") 2022/01/13 05:12:08 DEBUG : potato3: Deleting (id "4_z2f02ad83d09d5b1b7fe80e1b_f1157d2d1d550f9e8_d20220113_m051206_c001_v0001036_t0041") 2022/01/13 05:12:09 DEBUG : B2 bucket rclone-test-bovurab8xujefet3hequpuv9: Purge remote 2022/01/13 05:12:09 DEBUG : empty space: Deleting (id "4_z7f129d13d09d5b1b7fe80e1b_f109b2fa659561760_d20220113_m051201_c001_v0001134_t0017") 2022/01/13 05:12:09 DEBUG : potato2: Deleting (id "4_z7f129d13d09d5b1b7fe80e1b_f115a1b2a802227bd_d20220113_m051206_c001_v0001109_t0048") 2022/01/13 05:12:09 DEBUG : potato2: Deleting (id "4_z7f129d13d09d5b1b7fe80e1b_f1054982d151bf099_d20220113_m051203_c001_v0001117_t0013") 2022/01/13 05:12:09 DEBUG : potato3: Deleting (id "4_z7f129d13d09d5b1b7fe80e1b_f10299083413efda1_d20220113_m051207_c001_v0001120_t0004") 2022/01/13 05:12:09 DEBUG : potato3: Deleting (id "4_z7f129d13d09d5b1b7fe80e1b_f1089deb5f411e181_d20220113_m051203_c001_v0001113_t0022") 2022/01/13 05:12:09 DEBUG : potato3: Deleting (id "4_z7f129d13d09d5b1b7fe80e1b_f109b2fa659561765_d20220113_m051202_c001_v0001134_t0031") --- PASS: TestServerSideMoveWithFilter (21.29s) === RUN TestServerSideMoveDeleteEmptySourceDirs run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:12:14 DEBUG : Creating backend with remote "TestB2:rclone-test-cetutom0nokadut4suxecut0" 2022/01/13 05:12:19 DEBUG : tomatoDir: Making directory sync_test.go:1215: Server side move (if possible) B2 bucket rclone-test-gatazem7gokizuc4mixileb1 -> B2 bucket rclone-test-cetutom0nokadut4suxecut0 2022/01/13 05:12:23 DEBUG : empty space: Size and modification time the same (differ by 0s, within tolerance 1ms) 2022/01/13 05:12:23 DEBUG : empty space: Unchanged skipping 2022/01/13 05:12:23 DEBUG : potato3: Sizes differ (src 68 vs dst 60) 2022/01/13 05:12:23 DEBUG : B2 bucket rclone-test-cetutom0nokadut4suxecut0: Waiting for checks to finish 2022/01/13 05:12:24 INFO : empty space: Deleted 2022/01/13 05:12:24 DEBUG : B2 bucket rclone-test-cetutom0nokadut4suxecut0: Waiting for transfers to finish 2022/01/13 05:12:24 DEBUG : potato2: sha1 = 9dc7f7d3279715991a22853f5981df582b7f9f6d OK 2022/01/13 05:12:24 INFO : potato2: Copied (server-side copy) 2022/01/13 05:12:24 DEBUG : potato3: sha1 = 568f8850f3c1a384731dbe40c6d72e1dcae342a0 OK 2022/01/13 05:12:24 INFO : potato3: Copied (server-side copy) 2022/01/13 05:12:24 INFO : potato2: Deleted 2022/01/13 05:12:26 INFO : potato3: Deleted 2022/01/13 05:12:27 DEBUG : Creating backend with remote "TestB2:rclone-test-giqegem0cijekuz6yevohaf2" 2022/01/13 05:12:27 DEBUG : tomatoDir: Making directory 2022/01/13 05:12:28 DEBUG : B2 bucket rclone-test-giqegem0cijekuz6yevohaf2: Waiting for checks to finish 2022/01/13 05:12:28 DEBUG : B2 bucket rclone-test-giqegem0cijekuz6yevohaf2: Waiting for transfers to finish 2022/01/13 05:12:28 DEBUG : potato3: sha1 = 568f8850f3c1a384731dbe40c6d72e1dcae342a0 OK 2022/01/13 05:12:28 INFO : potato3: Copied (server-side copy) 2022/01/13 05:12:29 DEBUG : empty space: sha1 = 3bc15c8aae3e4124dd409035f32ea2fd6835efc9 OK 2022/01/13 05:12:29 INFO : empty space: Copied (server-side copy) 2022/01/13 05:12:29 INFO : empty space: Deleted 2022/01/13 05:12:29 INFO : potato3: Deleted 2022/01/13 05:12:30 DEBUG : potato2: sha1 = 9dc7f7d3279715991a22853f5981df582b7f9f6d OK 2022/01/13 05:12:30 INFO : potato2: Copied (server-side copy) 2022/01/13 05:12:31 INFO : potato2: Deleted 2022/01/13 05:12:31 DEBUG : B2 bucket rclone-test-giqegem0cijekuz6yevohaf2: Purge remote 2022/01/13 05:12:31 DEBUG : empty space: Deleting (id "4_z0f92fdf3d09d5b1b7fe80e1b_f118c0a13ce795229_d20220113_m051228_c001_v0001039_t0048") 2022/01/13 05:12:31 DEBUG : potato2: Deleting (id "4_z0f92fdf3d09d5b1b7fe80e1b_f110ef4122bc4dc1c_d20220113_m051228_c001_v0001117_t0051") 2022/01/13 05:12:31 DEBUG : potato3: Deleting (id "4_z0f92fdf3d09d5b1b7fe80e1b_f103688320f42d30a_d20220113_m051228_c001_v0001131_t0054") 2022/01/13 05:12:32 DEBUG : B2 bucket rclone-test-cetutom0nokadut4suxecut0: Purge remote 2022/01/13 05:12:32 DEBUG : empty space: Deleting (id "4_zaf52ddf3d09d5b1b7fe80e1b_f11626095c9bc28f5_d20220113_m051229_c001_v0001165_t0029") 2022/01/13 05:12:32 DEBUG : empty space: Deleting (id "4_zaf52ddf3d09d5b1b7fe80e1b_f110ef4122bc4dbb5_d20220113_m051221_c001_v0001117_t0040") 2022/01/13 05:12:32 DEBUG : potato2: Deleting (id "4_zaf52ddf3d09d5b1b7fe80e1b_f11252536aa3528ea_d20220113_m051230_c001_v0001117_t0012") 2022/01/13 05:12:32 DEBUG : potato2: Deleting (id "4_zaf52ddf3d09d5b1b7fe80e1b_f101febab719864a0_d20220113_m051224_c001_v0001009_t0006") 2022/01/13 05:12:32 DEBUG : potato3: Deleting (id "4_zaf52ddf3d09d5b1b7fe80e1b_f107150c010c8fa68_d20220113_m051228_c001_v0001097_t0052") 2022/01/13 05:12:32 DEBUG : potato3: Deleting (id "4_zaf52ddf3d09d5b1b7fe80e1b_f103a8c5cb4aaab44_d20220113_m051224_c001_v0001042_t0017") 2022/01/13 05:12:32 DEBUG : potato3: Deleting (id "4_zaf52ddf3d09d5b1b7fe80e1b_f110ef4122bc4dbbd_d20220113_m051221_c001_v0001117_t0032") --- PASS: TestServerSideMoveDeleteEmptySourceDirs (19.63s) === RUN TestServerSideMoveOverlap run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:12:34 DEBUG : Creating backend with remote "TestB2:rclone-test-gatazem7gokizuc4mixileb1/rclone-move-test" 2022/01/13 05:12:35 DEBUG : Couldn't decode error response: EOF --- PASS: TestServerSideMoveOverlap (3.64s) === RUN TestSyncOverlap run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:12:37 DEBUG : Creating backend with remote "TestB2:rclone-test-gatazem7gokizuc4mixileb1/rclone-sync-test" 2022/01/13 05:12:38 DEBUG : Couldn't decode error response: EOF --- PASS: TestSyncOverlap (0.76s) === RUN TestSyncCompareDest run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:12:38 DEBUG : Creating backend with remote "TestB2:rclone-test-gatazem7gokizuc4mixileb1/dst" 2022/01/13 05:12:38 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:12:38 DEBUG : Creating backend with remote "TestB2:rclone-test-gatazem7gokizuc4mixileb1/CompareDest" 2022/01/13 05:12:39 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:12:39 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:12:39 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for checks to finish 2022/01/13 05:12:39 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for transfers to finish 2022/01/13 05:12:42 DEBUG : one: sha1 = fe05bcdcdc4928012781a5f1a2a77cbb5398e106 OK 2022/01/13 05:12:42 INFO : one: Copied (new) 2022/01/13 05:12:42 DEBUG : Waiting for deletions to finish 2022/01/13 05:12:42 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for checks to finish 2022/01/13 05:12:43 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:12:43 DEBUG : one: Sizes differ (src 5 vs dst 3) 2022/01/13 05:12:43 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for transfers to finish 2022/01/13 05:12:44 DEBUG : one: sha1 = 7f376fd65843a1267de8f986d40e164e5a321c13 OK 2022/01/13 05:12:44 INFO : one: Copied (replaced existing) 2022/01/13 05:12:44 DEBUG : Waiting for deletions to finish 2022/01/13 05:12:46 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for checks to finish 2022/01/13 05:12:46 DEBUG : one: Size and modification time the same (differ by -456.789µs, within tolerance 1ms) 2022/01/13 05:12:46 DEBUG : one: Destination found in --compare-dest, skipping 2022/01/13 05:12:46 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for transfers to finish 2022/01/13 05:12:46 DEBUG : Waiting for deletions to finish 2022/01/13 05:12:46 INFO : There was nothing to transfer 2022/01/13 05:12:48 DEBUG : two: Size and modification time the same (differ by -456.789µs, within tolerance 1ms) 2022/01/13 05:12:48 DEBUG : two: Destination found in --compare-dest, skipping 2022/01/13 05:12:48 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for checks to finish 2022/01/13 05:12:49 DEBUG : one: Size and modification time the same (differ by -456.789µs, within tolerance 1ms) 2022/01/13 05:12:49 DEBUG : one: Destination found in --compare-dest, skipping 2022/01/13 05:12:49 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for transfers to finish 2022/01/13 05:12:49 DEBUG : Waiting for deletions to finish 2022/01/13 05:12:49 INFO : There was nothing to transfer 2022/01/13 05:12:49 DEBUG : two: Size and modification time the same (differ by -456.789µs, within tolerance 1ms) 2022/01/13 05:12:49 DEBUG : two: Destination found in --compare-dest, skipping 2022/01/13 05:12:49 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for checks to finish 2022/01/13 05:12:49 DEBUG : one: Size and modification time the same (differ by -456.789µs, within tolerance 1ms) 2022/01/13 05:12:49 DEBUG : one: Destination found in --compare-dest, skipping 2022/01/13 05:12:49 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for transfers to finish 2022/01/13 05:12:49 DEBUG : Waiting for deletions to finish 2022/01/13 05:12:49 INFO : There was nothing to transfer 2022/01/13 05:12:50 DEBUG : two: Modification times differ by -119h59m59.877s: 2011-12-30 12:59:59 +0000 UTC, 2011-12-25 12:59:59.123 +0000 UTC 2022/01/13 05:12:50 DEBUG : two: sha1 = ad782ecdac770fc6eb9a62e44f90873fb97fb26b OK 2022/01/13 05:12:50 DEBUG : two: Destination found in --compare-dest, skipping 2022/01/13 05:12:50 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for checks to finish 2022/01/13 05:12:50 DEBUG : one: Size and modification time the same (differ by -456.789µs, within tolerance 1ms) 2022/01/13 05:12:50 DEBUG : one: Destination found in --compare-dest, skipping 2022/01/13 05:12:50 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for transfers to finish 2022/01/13 05:12:50 DEBUG : Waiting for deletions to finish 2022/01/13 05:12:50 INFO : There was nothing to transfer 2022/01/13 05:12:51 DEBUG : two: Sizes differ (src 5 vs dst 3) 2022/01/13 05:12:51 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for checks to finish 2022/01/13 05:12:51 DEBUG : one: Size and modification time the same (differ by -456.789µs, within tolerance 1ms) 2022/01/13 05:12:51 DEBUG : one: Destination found in --compare-dest, skipping 2022/01/13 05:12:51 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for transfers to finish 2022/01/13 05:12:53 DEBUG : two: sha1 = a4be8877ad88f3109a6411985a1f359e10e2d930 OK 2022/01/13 05:12:53 INFO : two: Copied (new) 2022/01/13 05:12:53 DEBUG : Waiting for deletions to finish --- PASS: TestSyncCompareDest (16.84s) === RUN TestSyncMultipleCompareDest run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:12:57 DEBUG : Creating backend with remote "TestB2:rclone-test-gatazem7gokizuc4mixileb1/dest" 2022/01/13 05:12:58 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:12:58 DEBUG : Creating backend with remote "TestB2:rclone-test-gatazem7gokizuc4mixileb1/pre-dest1" 2022/01/13 05:12:59 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:12:59 DEBUG : Creating backend with remote "TestB2:rclone-test-gatazem7gokizuc4mixileb1/pre-dest2" 2022/01/13 05:12:59 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:13:00 DEBUG : 1: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:13:00 DEBUG : 1: Destination found in --compare-dest, skipping 2022/01/13 05:13:00 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:13:00 DEBUG : 2: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:13:00 DEBUG : 2: Destination found in --compare-dest, skipping 2022/01/13 05:13:00 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:13:01 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:13:01 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dest: Waiting for checks to finish 2022/01/13 05:13:01 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dest: Waiting for transfers to finish 2022/01/13 05:13:01 DEBUG : 3: sha1 = 77de68daecd823babbb58edb1c8e14d7106e83bb OK 2022/01/13 05:13:01 INFO : 3: Copied (new) 2022/01/13 05:13:01 DEBUG : Waiting for deletions to finish --- PASS: TestSyncMultipleCompareDest (11.14s) === RUN TestSyncCopyDest run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:13:06 DEBUG : Creating backend with remote "TestB2:rclone-test-gatazem7gokizuc4mixileb1/dst" 2022/01/13 05:13:07 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:13:07 DEBUG : Creating backend with remote "TestB2:rclone-test-gatazem7gokizuc4mixileb1/CopyDest" 2022/01/13 05:13:08 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:13:08 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:13:08 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for checks to finish 2022/01/13 05:13:08 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for transfers to finish 2022/01/13 05:13:09 DEBUG : one: sha1 = fe05bcdcdc4928012781a5f1a2a77cbb5398e106 OK 2022/01/13 05:13:09 INFO : one: Copied (new) 2022/01/13 05:13:09 DEBUG : Waiting for deletions to finish 2022/01/13 05:13:10 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for checks to finish 2022/01/13 05:13:10 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:13:10 DEBUG : one: Sizes differ (src 5 vs dst 3) 2022/01/13 05:13:10 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for transfers to finish 2022/01/13 05:13:12 DEBUG : one: sha1 = 7f376fd65843a1267de8f986d40e164e5a321c13 OK 2022/01/13 05:13:12 INFO : one: Copied (replaced existing) 2022/01/13 05:13:12 DEBUG : Waiting for deletions to finish 2022/01/13 05:13:18 DEBUG : Creating backend with remote "TestB2:rclone-test-gatazem7gokizuc4mixileb1/BackupDir" 2022/01/13 05:13:20 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:13:20 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for checks to finish 2022/01/13 05:13:20 DEBUG : one: Size and modification time the same (differ by -456.789µs, within tolerance 1ms) 2022/01/13 05:13:20 DEBUG : one: Sizes differ (src 5 vs dst 3) 2022/01/13 05:13:20 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:13:22 DEBUG : one: sha1 = fe05bcdcdc4928012781a5f1a2a77cbb5398e106 OK 2022/01/13 05:13:22 INFO : one: Copied (server-side copy) 2022/01/13 05:13:22 INFO : one: Deleted 2022/01/13 05:13:24 DEBUG : one: sha1 = 7f376fd65843a1267de8f986d40e164e5a321c13 OK 2022/01/13 05:13:24 INFO : one: Copied (server-side copy) 2022/01/13 05:13:24 DEBUG : one: Destination found in --copy-dest, using server-side copy 2022/01/13 05:13:24 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for transfers to finish 2022/01/13 05:13:24 DEBUG : Waiting for deletions to finish 2022/01/13 05:13:28 DEBUG : two: Size and modification time the same (differ by -456.789µs, within tolerance 1ms) 2022/01/13 05:13:29 DEBUG : two: sha1 = ad782ecdac770fc6eb9a62e44f90873fb97fb26b OK 2022/01/13 05:13:29 INFO : two: Copied (server-side copy) 2022/01/13 05:13:29 DEBUG : two: Destination found in --copy-dest, using server-side copy 2022/01/13 05:13:29 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for checks to finish 2022/01/13 05:13:29 DEBUG : one: Size and modification time the same (differ by -456.789µs, within tolerance 1ms) 2022/01/13 05:13:29 DEBUG : one: Size and modification time the same (differ by -456.789µs, within tolerance 1ms) 2022/01/13 05:13:29 DEBUG : one: Unchanged skipping 2022/01/13 05:13:29 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for transfers to finish 2022/01/13 05:13:29 DEBUG : Waiting for deletions to finish 2022/01/13 05:13:30 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for checks to finish 2022/01/13 05:13:30 DEBUG : one: Size and modification time the same (differ by -456.789µs, within tolerance 1ms) 2022/01/13 05:13:30 DEBUG : one: Size and modification time the same (differ by -456.789µs, within tolerance 1ms) 2022/01/13 05:13:30 DEBUG : one: Unchanged skipping 2022/01/13 05:13:30 DEBUG : two: Size and modification time the same (differ by -456.789µs, within tolerance 1ms) 2022/01/13 05:13:30 DEBUG : two: Size and modification time the same (differ by -456.789µs, within tolerance 1ms) 2022/01/13 05:13:30 DEBUG : two: Unchanged skipping 2022/01/13 05:13:30 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for transfers to finish 2022/01/13 05:13:30 DEBUG : Waiting for deletions to finish 2022/01/13 05:13:30 INFO : There was nothing to transfer 2022/01/13 05:13:31 DEBUG : three: Sizes differ (src 7 vs dst 5) 2022/01/13 05:13:31 DEBUG : three: Destination not found in --copy-dest 2022/01/13 05:13:31 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for checks to finish 2022/01/13 05:13:32 DEBUG : one: Size and modification time the same (differ by -456.789µs, within tolerance 1ms) 2022/01/13 05:13:32 DEBUG : one: Size and modification time the same (differ by -456.789µs, within tolerance 1ms) 2022/01/13 05:13:32 DEBUG : one: Unchanged skipping 2022/01/13 05:13:32 DEBUG : two: Size and modification time the same (differ by -456.789µs, within tolerance 1ms) 2022/01/13 05:13:32 DEBUG : two: Size and modification time the same (differ by -456.789µs, within tolerance 1ms) 2022/01/13 05:13:32 DEBUG : two: Unchanged skipping 2022/01/13 05:13:32 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for transfers to finish 2022/01/13 05:13:33 DEBUG : three: sha1 = 370e613335f3cf2f19b2a2d35a86402f55c659f8 OK 2022/01/13 05:13:33 INFO : three: Copied (new) 2022/01/13 05:13:33 DEBUG : Waiting for deletions to finish --- PASS: TestSyncCopyDest (32.57s) === RUN TestSyncBackupDir run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:13:44 DEBUG : Creating backend with remote "TestB2:rclone-test-gatazem7gokizuc4mixileb1/dst" 2022/01/13 05:13:45 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:13:45 DEBUG : Creating backend with remote "TestB2:rclone-test-gatazem7gokizuc4mixileb1/backup" 2022/01/13 05:13:46 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:13:46 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for checks to finish 2022/01/13 05:13:46 DEBUG : one: Sizes differ (src 4 vs dst 3) 2022/01/13 05:13:46 DEBUG : two: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:13:46 DEBUG : two: Unchanged skipping 2022/01/13 05:13:46 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:13:48 DEBUG : one: sha1 = fe05bcdcdc4928012781a5f1a2a77cbb5398e106 OK 2022/01/13 05:13:48 INFO : one: Copied (server-side copy) 2022/01/13 05:13:48 INFO : one: Deleted 2022/01/13 05:13:48 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for transfers to finish 2022/01/13 05:13:49 DEBUG : one: sha1 = d63a9910ed57f038b76549c070df6196b2102f42 OK 2022/01/13 05:13:49 INFO : one: Copied (new) 2022/01/13 05:13:49 DEBUG : Waiting for deletions to finish 2022/01/13 05:13:49 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:13:51 DEBUG : three.txt: sha1 = b802f384302cb24fbab0a44997e820bf2e8507bb OK 2022/01/13 05:13:51 INFO : three.txt: Copied (server-side copy) 2022/01/13 05:13:52 INFO : three.txt: Deleted 2022/01/13 05:13:52 INFO : three.txt: Moved into backup dir 2022/01/13 05:13:55 DEBUG : one: Sizes differ (src 5 vs dst 4) 2022/01/13 05:13:55 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for checks to finish 2022/01/13 05:13:55 DEBUG : two: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:13:55 DEBUG : two: Unchanged skipping 2022/01/13 05:13:56 DEBUG : one: sha1 = d63a9910ed57f038b76549c070df6196b2102f42 OK 2022/01/13 05:13:56 INFO : one: Copied (server-side copy) 2022/01/13 05:13:57 INFO : one: Deleted 2022/01/13 05:13:57 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for transfers to finish 2022/01/13 05:13:58 DEBUG : one: sha1 = 88a8c2880f555638f990d1ec4c8359b25caa20c7 OK 2022/01/13 05:13:58 INFO : one: Copied (new) 2022/01/13 05:13:58 DEBUG : Waiting for deletions to finish 2022/01/13 05:13:58 DEBUG : three.txt: sha1 = 92e0258fe3c7456f15dff78d509f6e3c9166c254 OK 2022/01/13 05:13:58 INFO : three.txt: Copied (server-side copy) 2022/01/13 05:13:59 INFO : three.txt: Deleted 2022/01/13 05:13:59 INFO : three.txt: Moved into backup dir --- PASS: TestSyncBackupDir (23.45s) === RUN TestSyncBackupDirWithSuffix run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:14:09 DEBUG : Creating backend with remote "TestB2:rclone-test-gatazem7gokizuc4mixileb1/dst" 2022/01/13 05:14:11 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:14:11 DEBUG : Creating backend with remote "TestB2:rclone-test-gatazem7gokizuc4mixileb1/backup" 2022/01/13 05:14:11 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:14:12 DEBUG : one: Sizes differ (src 4 vs dst 3) 2022/01/13 05:14:12 DEBUG : two: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:14:12 DEBUG : two: Unchanged skipping 2022/01/13 05:14:12 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for checks to finish 2022/01/13 05:14:12 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:14:13 DEBUG : one: sha1 = fe05bcdcdc4928012781a5f1a2a77cbb5398e106 OK 2022/01/13 05:14:13 INFO : one: Copied (server-side copy) to: one.bak 2022/01/13 05:14:15 INFO : one: Deleted 2022/01/13 05:14:15 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for transfers to finish 2022/01/13 05:14:17 DEBUG : one: sha1 = d63a9910ed57f038b76549c070df6196b2102f42 OK 2022/01/13 05:14:17 INFO : one: Copied (new) 2022/01/13 05:14:17 DEBUG : Waiting for deletions to finish 2022/01/13 05:14:18 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:14:18 DEBUG : three.txt: sha1 = b802f384302cb24fbab0a44997e820bf2e8507bb OK 2022/01/13 05:14:18 INFO : three.txt: Copied (server-side copy) to: three.txt.bak 2022/01/13 05:14:18 INFO : three.txt: Deleted 2022/01/13 05:14:18 INFO : three.txt: Moved into backup dir 2022/01/13 05:14:20 DEBUG : one: Sizes differ (src 5 vs dst 4) 2022/01/13 05:14:20 DEBUG : two: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:14:20 DEBUG : two: Unchanged skipping 2022/01/13 05:14:20 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for checks to finish 2022/01/13 05:14:20 DEBUG : one: sha1 = d63a9910ed57f038b76549c070df6196b2102f42 OK 2022/01/13 05:14:20 INFO : one: Copied (server-side copy) to: one.bak 2022/01/13 05:14:21 INFO : one: Deleted 2022/01/13 05:14:21 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for transfers to finish 2022/01/13 05:14:22 DEBUG : one: sha1 = 88a8c2880f555638f990d1ec4c8359b25caa20c7 OK 2022/01/13 05:14:22 INFO : one: Copied (new) 2022/01/13 05:14:22 DEBUG : Waiting for deletions to finish 2022/01/13 05:14:23 DEBUG : three.txt: sha1 = 92e0258fe3c7456f15dff78d509f6e3c9166c254 OK 2022/01/13 05:14:23 INFO : three.txt: Copied (server-side copy) to: three.txt.bak 2022/01/13 05:14:24 INFO : three.txt: Deleted 2022/01/13 05:14:24 INFO : three.txt: Moved into backup dir --- PASS: TestSyncBackupDirWithSuffix (25.70s) === RUN TestSyncBackupDirWithSuffixKeepExtension run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:14:31 DEBUG : Creating backend with remote "TestB2:rclone-test-gatazem7gokizuc4mixileb1/dst" 2022/01/13 05:14:33 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:14:33 DEBUG : Creating backend with remote "TestB2:rclone-test-gatazem7gokizuc4mixileb1/backup" 2022/01/13 05:14:33 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:14:33 DEBUG : one: Sizes differ (src 4 vs dst 3) 2022/01/13 05:14:33 DEBUG : two: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:14:33 DEBUG : two: Unchanged skipping 2022/01/13 05:14:33 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for checks to finish 2022/01/13 05:14:34 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:14:35 DEBUG : one: sha1 = fe05bcdcdc4928012781a5f1a2a77cbb5398e106 OK 2022/01/13 05:14:35 INFO : one: Copied (server-side copy) to: one-2019-01-01 2022/01/13 05:14:35 INFO : one: Deleted 2022/01/13 05:14:35 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for transfers to finish 2022/01/13 05:14:37 DEBUG : one: sha1 = d63a9910ed57f038b76549c070df6196b2102f42 OK 2022/01/13 05:14:37 INFO : one: Copied (new) 2022/01/13 05:14:37 DEBUG : Waiting for deletions to finish 2022/01/13 05:14:37 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:14:37 DEBUG : three.txt: sha1 = b802f384302cb24fbab0a44997e820bf2e8507bb OK 2022/01/13 05:14:37 INFO : three.txt: Copied (server-side copy) to: three-2019-01-01.txt 2022/01/13 05:14:39 INFO : three.txt: Deleted 2022/01/13 05:14:39 INFO : three.txt: Moved into backup dir 2022/01/13 05:14:41 DEBUG : one: Sizes differ (src 5 vs dst 4) 2022/01/13 05:14:41 DEBUG : two: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:14:41 DEBUG : two: Unchanged skipping 2022/01/13 05:14:41 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for checks to finish 2022/01/13 05:14:42 DEBUG : one: sha1 = d63a9910ed57f038b76549c070df6196b2102f42 OK 2022/01/13 05:14:42 INFO : one: Copied (server-side copy) to: one-2019-01-01 2022/01/13 05:14:43 INFO : one: Deleted 2022/01/13 05:14:43 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for transfers to finish 2022/01/13 05:14:44 DEBUG : one: sha1 = 88a8c2880f555638f990d1ec4c8359b25caa20c7 OK 2022/01/13 05:14:44 INFO : one: Copied (new) 2022/01/13 05:14:44 DEBUG : Waiting for deletions to finish 2022/01/13 05:14:45 DEBUG : three.txt: sha1 = 92e0258fe3c7456f15dff78d509f6e3c9166c254 OK 2022/01/13 05:14:45 INFO : three.txt: Copied (server-side copy) to: three-2019-01-01.txt 2022/01/13 05:14:45 INFO : three.txt: Deleted 2022/01/13 05:14:45 INFO : three.txt: Moved into backup dir --- PASS: TestSyncBackupDirWithSuffixKeepExtension (20.82s) === RUN TestSyncBackupDirSuffixOnly run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:14:52 DEBUG : Creating backend with remote "TestB2:rclone-test-gatazem7gokizuc4mixileb1/dst" 2022/01/13 05:14:54 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:14:54 DEBUG : one: Sizes differ (src 4 vs dst 3) 2022/01/13 05:14:54 DEBUG : two: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:14:54 DEBUG : two: Unchanged skipping 2022/01/13 05:14:54 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for checks to finish 2022/01/13 05:14:54 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:14:55 DEBUG : one: sha1 = fe05bcdcdc4928012781a5f1a2a77cbb5398e106 OK 2022/01/13 05:14:55 INFO : one: Copied (server-side copy) to: one.bak 2022/01/13 05:14:56 INFO : one: Deleted 2022/01/13 05:14:56 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for transfers to finish 2022/01/13 05:14:58 DEBUG : one: sha1 = d63a9910ed57f038b76549c070df6196b2102f42 OK 2022/01/13 05:14:58 INFO : one: Copied (new) 2022/01/13 05:14:58 DEBUG : Waiting for deletions to finish 2022/01/13 05:14:58 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:14:59 DEBUG : three.txt: sha1 = b802f384302cb24fbab0a44997e820bf2e8507bb OK 2022/01/13 05:14:59 INFO : three.txt: Copied (server-side copy) to: three.txt.bak 2022/01/13 05:15:01 INFO : three.txt: Deleted 2022/01/13 05:15:01 INFO : three.txt: Moved into backup dir 2022/01/13 05:15:03 DEBUG : one.bak: Excluded 2022/01/13 05:15:03 DEBUG : three.txt.bak: Excluded 2022/01/13 05:15:03 DEBUG : one: Sizes differ (src 5 vs dst 4) 2022/01/13 05:15:03 DEBUG : two: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:15:03 DEBUG : two: Unchanged skipping 2022/01/13 05:15:03 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for checks to finish 2022/01/13 05:15:04 DEBUG : one: sha1 = d63a9910ed57f038b76549c070df6196b2102f42 OK 2022/01/13 05:15:04 INFO : one: Copied (server-side copy) to: one.bak 2022/01/13 05:15:04 INFO : one: Deleted 2022/01/13 05:15:04 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1 path dst: Waiting for transfers to finish 2022/01/13 05:15:05 DEBUG : one: sha1 = 88a8c2880f555638f990d1ec4c8359b25caa20c7 OK 2022/01/13 05:15:05 INFO : one: Copied (new) 2022/01/13 05:15:05 DEBUG : Waiting for deletions to finish 2022/01/13 05:15:06 DEBUG : three.txt: sha1 = 92e0258fe3c7456f15dff78d509f6e3c9166c254 OK 2022/01/13 05:15:06 INFO : three.txt: Copied (server-side copy) to: three.txt.bak 2022/01/13 05:15:14 INFO : three.txt: Deleted 2022/01/13 05:15:14 INFO : three.txt: Moved into backup dir --- PASS: TestSyncBackupDirSuffixOnly (30.34s) === RUN TestSyncSuffix run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:15:23 DEBUG : Creating backend with remote "TestB2:rclone-test-gatazem7gokizuc4mixileb1/dst" 2022/01/13 05:15:25 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:15:25 DEBUG : one: Sizes differ (src 4 vs dst 3) 2022/01/13 05:15:25 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:15:27 DEBUG : one: sha1 = fe05bcdcdc4928012781a5f1a2a77cbb5398e106 OK 2022/01/13 05:15:27 INFO : one: Copied (server-side copy) to: one.bak 2022/01/13 05:15:27 INFO : one: Deleted 2022/01/13 05:15:28 DEBUG : one: sha1 = d63a9910ed57f038b76549c070df6196b2102f42 OK 2022/01/13 05:15:28 INFO : one: Copied (new) 2022/01/13 05:15:29 DEBUG : two: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:15:29 DEBUG : two: Unchanged skipping 2022/01/13 05:15:29 DEBUG : three.txt: Sizes differ (src 6 vs dst 5) 2022/01/13 05:15:29 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:15:30 DEBUG : three.txt: sha1 = b802f384302cb24fbab0a44997e820bf2e8507bb OK 2022/01/13 05:15:30 INFO : three.txt: Copied (server-side copy) to: three.txt.bak 2022/01/13 05:15:30 INFO : three.txt: Deleted 2022/01/13 05:15:32 DEBUG : three.txt: sha1 = 92e0258fe3c7456f15dff78d509f6e3c9166c254 OK 2022/01/13 05:15:32 INFO : three.txt: Copied (new) 2022/01/13 05:15:32 DEBUG : one: Sizes differ (src 5 vs dst 4) 2022/01/13 05:15:33 DEBUG : one: sha1 = d63a9910ed57f038b76549c070df6196b2102f42 OK 2022/01/13 05:15:33 INFO : one: Copied (server-side copy) to: one.bak 2022/01/13 05:15:34 INFO : one: Deleted 2022/01/13 05:15:36 DEBUG : one: sha1 = 88a8c2880f555638f990d1ec4c8359b25caa20c7 OK 2022/01/13 05:15:36 INFO : one: Copied (new) 2022/01/13 05:15:36 DEBUG : two: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:15:36 DEBUG : two: Unchanged skipping 2022/01/13 05:15:36 DEBUG : three.txt: Sizes differ (src 19 vs dst 6) 2022/01/13 05:15:37 DEBUG : three.txt: sha1 = 92e0258fe3c7456f15dff78d509f6e3c9166c254 OK 2022/01/13 05:15:37 INFO : three.txt: Copied (server-side copy) to: three.txt.bak 2022/01/13 05:15:38 INFO : three.txt: Deleted 2022/01/13 05:15:39 DEBUG : three.txt: sha1 = 476e1707cbd7f0497a7dc4d44f0b07b8566ffc30 OK 2022/01/13 05:15:39 INFO : three.txt: Copied (new) --- PASS: TestSyncSuffix (23.72s) === RUN TestSyncSuffixKeepExtension run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:15:49 DEBUG : Creating backend with remote "TestB2:rclone-test-gatazem7gokizuc4mixileb1/dst" 2022/01/13 05:15:50 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:15:51 DEBUG : one: Sizes differ (src 4 vs dst 3) 2022/01/13 05:15:51 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:15:53 DEBUG : one: sha1 = fe05bcdcdc4928012781a5f1a2a77cbb5398e106 OK 2022/01/13 05:15:53 INFO : one: Copied (server-side copy) to: one-2019-01-01 2022/01/13 05:15:54 INFO : one: Deleted 2022/01/13 05:15:56 DEBUG : one: sha1 = d63a9910ed57f038b76549c070df6196b2102f42 OK 2022/01/13 05:15:56 INFO : one: Copied (new) 2022/01/13 05:15:57 DEBUG : two: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:15:57 DEBUG : two: Unchanged skipping 2022/01/13 05:15:57 DEBUG : three.txt: Sizes differ (src 6 vs dst 5) 2022/01/13 05:15:57 DEBUG : Couldn't decode error response: EOF 2022/01/13 05:15:58 DEBUG : three.txt: sha1 = b802f384302cb24fbab0a44997e820bf2e8507bb OK 2022/01/13 05:15:58 INFO : three.txt: Copied (server-side copy) to: three-2019-01-01.txt 2022/01/13 05:15:58 INFO : three.txt: Deleted 2022/01/13 05:15:59 DEBUG : three.txt: sha1 = 92e0258fe3c7456f15dff78d509f6e3c9166c254 OK 2022/01/13 05:15:59 INFO : three.txt: Copied (new) 2022/01/13 05:16:00 DEBUG : one: Sizes differ (src 5 vs dst 4) 2022/01/13 05:16:00 DEBUG : one: sha1 = d63a9910ed57f038b76549c070df6196b2102f42 OK 2022/01/13 05:16:00 INFO : one: Copied (server-side copy) to: one-2019-01-01 2022/01/13 05:16:01 INFO : one: Deleted 2022/01/13 05:16:03 DEBUG : one: sha1 = 88a8c2880f555638f990d1ec4c8359b25caa20c7 OK 2022/01/13 05:16:03 INFO : one: Copied (new) 2022/01/13 05:16:03 DEBUG : two: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:16:03 DEBUG : two: Unchanged skipping 2022/01/13 05:16:04 DEBUG : three.txt: Sizes differ (src 19 vs dst 6) 2022/01/13 05:16:04 DEBUG : three.txt: sha1 = 92e0258fe3c7456f15dff78d509f6e3c9166c254 OK 2022/01/13 05:16:04 INFO : three.txt: Copied (server-side copy) to: three-2019-01-01.txt 2022/01/13 05:16:05 INFO : three.txt: Deleted 2022/01/13 05:16:06 DEBUG : three.txt: sha1 = 476e1707cbd7f0497a7dc4d44f0b07b8566ffc30 OK 2022/01/13 05:16:06 INFO : three.txt: Copied (new) --- PASS: TestSyncSuffixKeepExtension (28.14s) === RUN TestSyncUTFNorm run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:16:12 DEBUG : Testêé: Sizes differ (src 14 vs dst 18) 2022/01/13 05:16:12 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:16:12 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:16:14 DEBUG : Testêé: sha1 = a54d88e06612d820bc3be72877c74f257b561b19 OK 2022/01/13 05:16:14 INFO : Testêé: Copied (replaced existing) to: Testêé 2022/01/13 05:16:14 DEBUG : Waiting for deletions to finish --- PASS: TestSyncUTFNorm (5.14s) === RUN TestSyncImmutable run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:16:16 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:16:16 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:16:17 DEBUG : existing: sha1 = 3e2e95f5ad970eadfa7e17eaf73da97024aa5359 OK 2022/01/13 05:16:17 INFO : existing: Copied (new) 2022/01/13 05:16:17 DEBUG : Waiting for deletions to finish 2022/01/13 05:16:18 DEBUG : existing: Sizes differ (src 8 vs dst 6) 2022/01/13 05:16:18 ERROR : existing: Source and destination exist but do not match: immutable file modified 2022/01/13 05:16:18 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:16:18 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:16:18 ERROR : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: not deleting files as there were IO errors 2022/01/13 05:16:18 ERROR : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: not deleting directories as there were IO errors --- PASS: TestSyncImmutable (2.78s) === RUN TestSyncIgnoreCase run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:16:20 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:16:20 DEBUG : existing: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:16:20 DEBUG : existing: Unchanged skipping 2022/01/13 05:16:20 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:16:20 DEBUG : Waiting for deletions to finish 2022/01/13 05:16:20 INFO : There was nothing to transfer --- PASS: TestSyncIgnoreCase (2.13s) === RUN TestMaxTransfer === RUN TestMaxTransfer/Hard run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" sync_test.go:1989: This test only runs on local === RUN TestMaxTransfer/Soft run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" sync_test.go:1989: This test only runs on local === RUN TestMaxTransfer/Cautious run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" sync_test.go:1989: This test only runs on local --- PASS: TestMaxTransfer (1.06s) --- SKIP: TestMaxTransfer/Hard (0.35s) --- SKIP: TestMaxTransfer/Soft (0.35s) --- SKIP: TestMaxTransfer/Cautious (0.36s) === RUN TestSyncConcurrentDelete run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:17:00 DEBUG : both0: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:17:00 DEBUG : both0: Unchanged skipping 2022/01/13 05:17:00 DEBUG : both10: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:17:00 DEBUG : both10: Unchanged skipping 2022/01/13 05:17:00 DEBUG : both11: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:17:00 DEBUG : both11: Unchanged skipping 2022/01/13 05:17:00 DEBUG : both12: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:17:00 DEBUG : both12: Unchanged skipping 2022/01/13 05:17:00 DEBUG : both13: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:17:00 DEBUG : both13: Unchanged skipping 2022/01/13 05:17:00 DEBUG : both14: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:17:00 DEBUG : both14: Unchanged skipping 2022/01/13 05:17:00 DEBUG : both15: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:17:00 DEBUG : both15: Unchanged skipping 2022/01/13 05:17:00 DEBUG : both16: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:17:00 DEBUG : both16: Unchanged skipping 2022/01/13 05:17:00 DEBUG : both17: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:17:00 DEBUG : both17: Unchanged skipping 2022/01/13 05:17:00 DEBUG : both18: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:17:00 DEBUG : both18: Unchanged skipping 2022/01/13 05:17:00 DEBUG : both19: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:17:00 DEBUG : both19: Unchanged skipping 2022/01/13 05:17:00 DEBUG : both2: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:17:00 DEBUG : both2: Unchanged skipping 2022/01/13 05:17:00 DEBUG : both3: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:17:00 DEBUG : both3: Unchanged skipping 2022/01/13 05:17:00 DEBUG : both4: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:17:00 DEBUG : both4: Unchanged skipping 2022/01/13 05:17:00 DEBUG : both5: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:17:00 DEBUG : both5: Unchanged skipping 2022/01/13 05:17:00 DEBUG : both6: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:17:00 DEBUG : both6: Unchanged skipping 2022/01/13 05:17:00 DEBUG : both7: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:17:00 DEBUG : both7: Unchanged skipping 2022/01/13 05:17:00 DEBUG : both8: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:17:00 DEBUG : both8: Unchanged skipping 2022/01/13 05:17:00 DEBUG : both9: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:17:00 DEBUG : both9: Unchanged skipping 2022/01/13 05:17:00 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:17:00 DEBUG : both1: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:17:00 DEBUG : both1: Unchanged skipping 2022/01/13 05:17:00 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:17:00 DEBUG : Waiting for deletions to finish 2022/01/13 05:17:00 INFO : only3: Deleted 2022/01/13 05:17:01 INFO : only4: Deleted 2022/01/13 05:17:01 INFO : only0: Deleted 2022/01/13 05:17:01 INFO : only19: Deleted 2022/01/13 05:17:01 INFO : only14: Deleted 2022/01/13 05:17:02 INFO : only8: Deleted 2022/01/13 05:17:02 INFO : only17: Deleted 2022/01/13 05:17:02 INFO : only15: Deleted 2022/01/13 05:17:03 INFO : only16: Deleted 2022/01/13 05:17:03 INFO : only13: Deleted 2022/01/13 05:17:03 INFO : only7: Deleted 2022/01/13 05:17:03 INFO : only11: Deleted 2022/01/13 05:17:04 INFO : only5: Deleted 2022/01/13 05:17:04 INFO : only1: Deleted 2022/01/13 05:17:05 INFO : only12: Deleted 2022/01/13 05:17:05 INFO : only10: Deleted 2022/01/13 05:17:05 INFO : only6: Deleted 2022/01/13 05:17:05 INFO : only18: Deleted 2022/01/13 05:17:06 INFO : only9: Deleted 2022/01/13 05:17:07 INFO : only2: Deleted 2022/01/13 05:17:07 INFO : There was nothing to transfer --- PASS: TestSyncConcurrentDelete (63.07s) === RUN TestSyncConcurrentTruncate run.go:181: Remote "B2 bucket rclone-test-gatazem7gokizuc4mixileb1", Local "Local file system at /tmp/rclone2735015204", Modify Window "1ms" 2022/01/13 05:18:03 DEBUG : both0: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:18:03 DEBUG : both0: Unchanged skipping 2022/01/13 05:18:03 DEBUG : both1: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:18:03 DEBUG : both1: Unchanged skipping 2022/01/13 05:18:03 DEBUG : both10: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:18:03 DEBUG : both10: Unchanged skipping 2022/01/13 05:18:03 DEBUG : both11: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:18:03 DEBUG : both11: Unchanged skipping 2022/01/13 05:18:03 DEBUG : both12: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:18:03 DEBUG : both12: Unchanged skipping 2022/01/13 05:18:03 DEBUG : both13: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:18:03 DEBUG : both13: Unchanged skipping 2022/01/13 05:18:03 DEBUG : both14: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:18:03 DEBUG : both14: Unchanged skipping 2022/01/13 05:18:03 DEBUG : both15: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:18:03 DEBUG : both15: Unchanged skipping 2022/01/13 05:18:03 DEBUG : both16: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:18:03 DEBUG : both16: Unchanged skipping 2022/01/13 05:18:03 DEBUG : both17: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:18:03 DEBUG : both17: Unchanged skipping 2022/01/13 05:18:03 DEBUG : both18: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:18:03 DEBUG : both18: Unchanged skipping 2022/01/13 05:18:03 DEBUG : both19: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:18:03 DEBUG : both19: Unchanged skipping 2022/01/13 05:18:03 DEBUG : both2: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:18:03 DEBUG : both2: Unchanged skipping 2022/01/13 05:18:03 DEBUG : both3: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:18:03 DEBUG : both3: Unchanged skipping 2022/01/13 05:18:03 DEBUG : both4: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:18:03 DEBUG : both4: Unchanged skipping 2022/01/13 05:18:03 DEBUG : both5: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:18:03 DEBUG : both5: Unchanged skipping 2022/01/13 05:18:03 DEBUG : both6: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:18:03 DEBUG : both6: Unchanged skipping 2022/01/13 05:18:03 DEBUG : both7: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:18:03 DEBUG : both7: Unchanged skipping 2022/01/13 05:18:03 DEBUG : both8: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:18:03 DEBUG : both8: Unchanged skipping 2022/01/13 05:18:03 DEBUG : both9: Size and modification time the same (differ by -999.999µs, within tolerance 1ms) 2022/01/13 05:18:03 DEBUG : both9: Unchanged skipping 2022/01/13 05:18:03 DEBUG : only0: Sizes differ (src 0 vs dst 6) 2022/01/13 05:18:03 DEBUG : only1: Sizes differ (src 0 vs dst 6) 2022/01/13 05:18:03 DEBUG : only10: Sizes differ (src 0 vs dst 6) 2022/01/13 05:18:03 DEBUG : only11: Sizes differ (src 0 vs dst 6) 2022/01/13 05:18:03 DEBUG : only12: Sizes differ (src 0 vs dst 6) 2022/01/13 05:18:03 DEBUG : only13: Sizes differ (src 0 vs dst 6) 2022/01/13 05:18:03 DEBUG : only14: Sizes differ (src 0 vs dst 6) 2022/01/13 05:18:03 DEBUG : only15: Sizes differ (src 0 vs dst 6) 2022/01/13 05:18:03 DEBUG : only16: Sizes differ (src 0 vs dst 6) 2022/01/13 05:18:03 DEBUG : only17: Sizes differ (src 0 vs dst 6) 2022/01/13 05:18:03 DEBUG : only18: Sizes differ (src 0 vs dst 6) 2022/01/13 05:18:03 DEBUG : only19: Sizes differ (src 0 vs dst 6) 2022/01/13 05:18:03 DEBUG : only2: Sizes differ (src 0 vs dst 6) 2022/01/13 05:18:03 DEBUG : only3: Sizes differ (src 0 vs dst 6) 2022/01/13 05:18:03 DEBUG : only4: Sizes differ (src 0 vs dst 6) 2022/01/13 05:18:03 DEBUG : only5: Sizes differ (src 0 vs dst 6) 2022/01/13 05:18:03 DEBUG : only6: Sizes differ (src 0 vs dst 6) 2022/01/13 05:18:03 DEBUG : only7: Sizes differ (src 0 vs dst 6) 2022/01/13 05:18:03 DEBUG : only8: Sizes differ (src 0 vs dst 6) 2022/01/13 05:18:03 DEBUG : only9: Sizes differ (src 0 vs dst 6) 2022/01/13 05:18:03 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for checks to finish 2022/01/13 05:18:03 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Waiting for transfers to finish 2022/01/13 05:18:03 DEBUG : only10: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK 2022/01/13 05:18:03 INFO : only10: Copied (replaced existing) 2022/01/13 05:18:03 DEBUG : only0: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK 2022/01/13 05:18:03 INFO : only0: Copied (replaced existing) 2022/01/13 05:18:03 DEBUG : only1: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK 2022/01/13 05:18:03 INFO : only1: Copied (replaced existing) 2022/01/13 05:18:04 DEBUG : only12: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK 2022/01/13 05:18:04 INFO : only12: Copied (replaced existing) 2022/01/13 05:18:04 DEBUG : only14: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK 2022/01/13 05:18:04 INFO : only14: Copied (replaced existing) 2022/01/13 05:18:04 DEBUG : only15: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK 2022/01/13 05:18:04 INFO : only15: Copied (replaced existing) 2022/01/13 05:18:04 DEBUG : only11: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK 2022/01/13 05:18:04 INFO : only11: Copied (replaced existing) 2022/01/13 05:18:05 DEBUG : only17: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK 2022/01/13 05:18:05 INFO : only17: Copied (replaced existing) 2022/01/13 05:18:05 DEBUG : only16: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK 2022/01/13 05:18:05 INFO : only16: Copied (replaced existing) 2022/01/13 05:18:05 DEBUG : only18: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK 2022/01/13 05:18:05 INFO : only18: Copied (replaced existing) 2022/01/13 05:18:05 DEBUG : only19: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK 2022/01/13 05:18:05 INFO : only19: Copied (replaced existing) 2022/01/13 05:18:05 DEBUG : only3: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK 2022/01/13 05:18:05 INFO : only3: Copied (replaced existing) 2022/01/13 05:18:05 DEBUG : only2: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK 2022/01/13 05:18:05 INFO : only2: Copied (replaced existing) 2022/01/13 05:18:05 DEBUG : only4: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK 2022/01/13 05:18:05 INFO : only4: Copied (replaced existing) 2022/01/13 05:18:06 DEBUG : only13: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK 2022/01/13 05:18:06 INFO : only13: Copied (replaced existing) 2022/01/13 05:18:06 DEBUG : only7: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK 2022/01/13 05:18:06 INFO : only7: Copied (replaced existing) 2022/01/13 05:18:06 DEBUG : only5: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK 2022/01/13 05:18:06 INFO : only5: Copied (replaced existing) 2022/01/13 05:18:06 DEBUG : only9: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK 2022/01/13 05:18:06 INFO : only9: Copied (replaced existing) 2022/01/13 05:18:06 DEBUG : only8: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK 2022/01/13 05:18:06 INFO : only8: Copied (replaced existing) 2022/01/13 05:18:07 DEBUG : only6: sha1 = da39a3ee5e6b4b0d3255bfef95601890afd80709 OK 2022/01/13 05:18:07 INFO : only6: Copied (replaced existing) 2022/01/13 05:18:07 DEBUG : Waiting for deletions to finish --- PASS: TestSyncConcurrentTruncate (71.61s) PASS 2022/01/13 05:18:37 DEBUG : B2 bucket rclone-test-gatazem7gokizuc4mixileb1: Purge remote 2022/01/13 05:18:37 DEBUG : BackupDir/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f110b3b79a2cee3ed_d20220113_m051333_c001_v0001030_t0034") 2022/01/13 05:18:37 DEBUG : BackupDir/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f101d9a9db4f36fe3_d20220113_m051321_c001_v0001165_t0004") 2022/01/13 05:18:37 DEBUG : CompareDest/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f11797b246fcaf2ed_d20220113_m051253_c001_v0001165_t0050") 2022/01/13 05:18:37 DEBUG : CompareDest/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180c9b_d20220113_m051245_c001_v0001033_t0034") 2022/01/13 05:18:37 DEBUG : CompareDest/two: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1009dee1ea13709a_d20220113_m051253_c001_v0001157_t0010") 2022/01/13 05:18:37 DEBUG : CompareDest/two: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac67f90_d20220113_m051247_c001_v0001105_t0013") 2022/01/13 05:18:37 DEBUG : CopyDest/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f115ac477b77fa7e2_d20220113_m051334_c001_v0001105_t0032") 2022/01/13 05:18:37 DEBUG : CopyDest/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a00a93_d20220113_m051317_c001_v0001131_t0050") 2022/01/13 05:18:37 DEBUG : CopyDest/three: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1006bac54c3d5bfc_d20220113_m051335_c001_v0001131_t0003") 2022/01/13 05:18:37 DEBUG : CopyDest/three: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac685fe_d20220113_m051331_c001_v0001105_t0031") 2022/01/13 05:18:37 DEBUG : CopyDest/two: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1137b0cfad0eff0b_d20220113_m051336_c001_v0001109_t0037") 2022/01/13 05:18:38 DEBUG : CopyDest/two: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180d64_d20220113_m051325_c001_v0001033_t0023") 2022/01/13 05:18:38 DEBUG : EXISTING: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f119fc4154b886da0_d20220113_m051620_c001_v0001134_t0050") 2022/01/13 05:18:38 DEBUG : EXISTING: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf181096_d20220113_m051619_c001_v0001033_t0034") 2022/01/13 05:18:38 DEBUG : Testêé: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1023be88de58e80e_d20220113_m051614_c001_v0001105_t0001") 2022/01/13 05:18:38 DEBUG : Testêé: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac69e2e_d20220113_m051613_c001_v0001105_t0050") 2022/01/13 05:18:38 DEBUG : Testêé: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf18106f_d20220113_m051611_c001_v0001033_t0038") 2022/01/13 05:18:38 DEBUG : a/potato2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f119b8ad5b5649618_d20220113_m051023_c001_v0001038_t0034") 2022/01/13 05:18:38 DEBUG : a/potato2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180a2c_d20220113_m051022_c001_v0001033_t0020") 2022/01/13 05:18:38 DEBUG : a/potato2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f101d9a9db4f363a7_d20220113_m051019_c001_v0001165_t0013") 2022/01/13 05:18:38 DEBUG : a/potato2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180a08_d20220113_m051015_c001_v0001033_t0056") 2022/01/13 05:18:38 DEBUG : a/potato2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f10721a8b5d47e2a0_d20220113_m050937_c001_v0001157_t0018") 2022/01/13 05:18:38 DEBUG : a/potato2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180943_d20220113_m050934_c001_v0001033_t0048") 2022/01/13 05:18:38 DEBUG : b/potato: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f11012dfc3c57e46a_d20220113_m051024_c001_v0001105_t0043") 2022/01/13 05:18:38 DEBUG : b/potato: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180a17_d20220113_m051020_c001_v0001033_t0012") 2022/01/13 05:18:38 DEBUG : b/potato: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f106ce8c74b7b5e0d_d20220113_m051017_c001_v0001134_t0035") 2022/01/13 05:18:39 DEBUG : b/potato: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf1809fb_d20220113_m051013_c001_v0001033_t0039") 2022/01/13 05:18:39 DEBUG : b/potato: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f11848e9a1e1e24a1_d20220113_m050936_c001_v0001043_t0032") 2022/01/13 05:18:39 DEBUG : b/potato: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf18093a_d20220113_m050933_c001_v0001033_t0022") 2022/01/13 05:18:39 DEBUG : backup/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1102c07c76052f19_d20220113_m051400_c001_v0001092_t0047") 2022/01/13 05:18:39 DEBUG : backup/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f105b786bacf2be61_d20220113_m051356_c001_v0001109_t0040") 2022/01/13 05:18:39 DEBUG : backup/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f106ae7f062538209_d20220113_m051347_c001_v0001161_t0009") 2022/01/13 05:18:39 DEBUG : backup/one-2019-01-01: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f107a009d3a0dd1a3_d20220113_m051446_c001_v0001105_t0032") 2022/01/13 05:18:39 DEBUG : backup/one-2019-01-01: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f11406b41066f366f_d20220113_m051442_c001_v0001097_t0019") 2022/01/13 05:18:39 DEBUG : backup/one-2019-01-01: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f106a1c92a3360a01_d20220113_m051435_c001_v0001137_t0002") 2022/01/13 05:18:39 DEBUG : backup/one.bak: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f101632b202d3279a_d20220113_m051424_c001_v0001033_t0054") 2022/01/13 05:18:39 DEBUG : backup/one.bak: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1133f8d15b55221c_d20220113_m051420_c001_v0001105_t0015") 2022/01/13 05:18:39 DEBUG : backup/one.bak: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f118bb47f69abbd4b_d20220113_m051413_c001_v0001032_t0010") 2022/01/13 05:18:39 DEBUG : backup/three-2019-01-01.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f10567ad75866eff0_d20220113_m051446_c001_v0001105_t0033") 2022/01/13 05:18:39 DEBUG : backup/three-2019-01-01.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1179c3881f293820_d20220113_m051445_c001_v0001136_t0058") 2022/01/13 05:18:39 DEBUG : backup/three-2019-01-01.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f118b42accd71f263_d20220113_m051437_c001_v0001109_t0047") 2022/01/13 05:18:39 DEBUG : backup/three.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1133f8d15b551f48_d20220113_m051400_c001_v0001105_t0025") 2022/01/13 05:18:39 DEBUG : backup/three.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f115285fd1f063cd4_d20220113_m051358_c001_v0001130_t0029") 2022/01/13 05:18:39 DEBUG : backup/three.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1186e43dff7ce5c4_d20220113_m051350_c001_v0001105_t0021") 2022/01/13 05:18:39 DEBUG : backup/three.txt.bak: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f105926d518780b83_d20220113_m051426_c001_v0001120_t0023") 2022/01/13 05:18:39 DEBUG : backup/three.txt.bak: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1075212e9f101cbc_d20220113_m051423_c001_v0001145_t0006") 2022/01/13 05:18:39 DEBUG : backup/three.txt.bak: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f102bb1c81e454fde_d20220113_m051418_c001_v0001165_t0020") 2022/01/13 05:18:40 DEBUG : both0: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1059ba106c21b40f_d20220113_m051807_c001_v0001098_t0058") 2022/01/13 05:18:40 DEBUG : both0: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a013a3_d20220113_m051726_c001_v0001131_t0050") 2022/01/13 05:18:40 DEBUG : both0: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f10567ad7586701c8_d20220113_m051707_c001_v0001105_t0011") 2022/01/13 05:18:40 DEBUG : both0: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac69f8d_d20220113_m051623_c001_v0001105_t0032") 2022/01/13 05:18:40 DEBUG : both1: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1023be88de58f46f_d20220113_m051808_c001_v0001105_t0012") 2022/01/13 05:18:40 DEBUG : both1: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac6a83a_d20220113_m051727_c001_v0001105_t0055") 2022/01/13 05:18:40 DEBUG : both1: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1115f2f71a717796_d20220113_m051708_c001_v0001105_t0049") 2022/01/13 05:18:40 DEBUG : both1: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf1810c0_d20220113_m051626_c001_v0001033_t0043") 2022/01/13 05:18:40 DEBUG : both10: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f11373ae39cc7b6fd_d20220113_m051808_c001_v0001154_t0021") 2022/01/13 05:18:40 DEBUG : both10: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac6aa5c_d20220113_m051744_c001_v0001105_t0059") 2022/01/13 05:18:40 DEBUG : both10: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f118a6b0f625225d0_d20220113_m051709_c001_v0001097_t0037") 2022/01/13 05:18:40 DEBUG : both10: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf181129_d20220113_m051644_c001_v0001033_t0023") 2022/01/13 05:18:40 DEBUG : both11: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1072f4c867e6411c_d20220113_m051809_c001_v0001033_t0026") 2022/01/13 05:18:40 DEBUG : both11: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf181241_d20220113_m051745_c001_v0001033_t0023") 2022/01/13 05:18:40 DEBUG : both11: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f115285fd1f063fed_d20220113_m051710_c001_v0001130_t0056") 2022/01/13 05:18:40 DEBUG : both11: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a01298_d20220113_m051647_c001_v0001131_t0047") 2022/01/13 05:18:40 DEBUG : both12: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f108e73366934fe5c_d20220113_m051809_c001_v0001134_t0013") 2022/01/13 05:18:40 DEBUG : both12: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a0143f_d20220113_m051747_c001_v0001131_t0041") 2022/01/13 05:18:40 DEBUG : both12: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f100cb56336c3ae58_d20220113_m051710_c001_v0001097_t0019") 2022/01/13 05:18:40 DEBUG : both12: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac6a380_d20220113_m051648_c001_v0001105_t0040") 2022/01/13 05:18:40 DEBUG : both13: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f113ea5ba526948de_d20220113_m051810_c001_v0001131_t0012") 2022/01/13 05:18:40 DEBUG : both13: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac6aad9_d20220113_m051748_c001_v0001105_t0050") 2022/01/13 05:18:40 DEBUG : both13: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f110bbea8a9dcf7c2_d20220113_m051711_c001_v0001097_t0044") 2022/01/13 05:18:41 DEBUG : both13: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf181146_d20220113_m051649_c001_v0001033_t0049") 2022/01/13 05:18:41 DEBUG : both14: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f116cc99dc26e2a41_d20220113_m051810_c001_v0001098_t0039") 2022/01/13 05:18:41 DEBUG : both14: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf181262_d20220113_m051750_c001_v0001033_t0052") 2022/01/13 05:18:41 DEBUG : both14: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f10805e4d605b3af3_d20220113_m051717_c001_v0001000_t0028") 2022/01/13 05:18:41 DEBUG : both14: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a012bc_d20220113_m051652_c001_v0001131_t0055") 2022/01/13 05:18:41 DEBUG : both15: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f10343e46b5bc2457_d20220113_m051810_c001_v0001144_t0040") 2022/01/13 05:18:41 DEBUG : both15: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a01479_d20220113_m051752_c001_v0001131_t0034") 2022/01/13 05:18:41 DEBUG : both15: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1067e9b7e36faa89_d20220113_m051717_c001_v0001090_t0041") 2022/01/13 05:18:41 DEBUG : both15: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac6a444_d20220113_m051652_c001_v0001105_t0033") 2022/01/13 05:18:41 DEBUG : both16: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f110880b245f73533_d20220113_m051811_c001_v0001134_t0025") 2022/01/13 05:18:41 DEBUG : both16: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac6ab92_d20220113_m051753_c001_v0001105_t0006") 2022/01/13 05:18:41 DEBUG : both16: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f11984a64293ac3a5_d20220113_m051718_c001_v0001165_t0002") 2022/01/13 05:18:41 DEBUG : both16: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf18115d_d20220113_m051653_c001_v0001033_t0029") 2022/01/13 05:18:41 DEBUG : both17: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f103c1999389feca4_d20220113_m051811_c001_v0001105_t0013") 2022/01/13 05:18:41 DEBUG : both17: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf181281_d20220113_m051755_c001_v0001033_t0052") 2022/01/13 05:18:41 DEBUG : both17: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f109ae94d156f5a52_d20220113_m051718_c001_v0001105_t0009") 2022/01/13 05:18:41 DEBUG : both17: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a012de_d20220113_m051655_c001_v0001131_t0046") 2022/01/13 05:18:41 DEBUG : both18: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f101632b202d32ad9_d20220113_m051812_c001_v0001033_t0042") 2022/01/13 05:18:41 DEBUG : both18: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a014a8_d20220113_m051758_c001_v0001131_t0051") 2022/01/13 05:18:41 DEBUG : both18: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f106688e5797065a1_d20220113_m051720_c001_v0001165_t0045") 2022/01/13 05:18:42 DEBUG : both18: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac6a4cc_d20220113_m051656_c001_v0001105_t0015") 2022/01/13 05:18:42 DEBUG : both19: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f109e240a41403334_d20220113_m051813_c001_v0001150_t0057") 2022/01/13 05:18:42 DEBUG : both19: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac6acaa_d20220113_m051801_c001_v0001105_t0022") 2022/01/13 05:18:42 DEBUG : both19: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f114eb5c1d448535b_d20220113_m051720_c001_v0001019_t0020") 2022/01/13 05:18:42 DEBUG : both19: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf181171_d20220113_m051657_c001_v0001033_t0006") 2022/01/13 05:18:42 DEBUG : both2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1025601e0a24ef29_d20220113_m051813_c001_v0001098_t0057") 2022/01/13 05:18:42 DEBUG : both2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf1811e8_d20220113_m051728_c001_v0001033_t0018") 2022/01/13 05:18:42 DEBUG : both2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac6a78e_d20220113_m051720_c001_v0001105_t0050") 2022/01/13 05:18:42 DEBUG : both2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a011fd_d20220113_m051628_c001_v0001131_t0059") 2022/01/13 05:18:42 DEBUG : both3: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1047617ad1dfc6c1_d20220113_m051814_c001_v0001018_t0001") 2022/01/13 05:18:42 DEBUG : both3: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a013d5_d20220113_m051732_c001_v0001131_t0032") 2022/01/13 05:18:42 DEBUG : both3: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f106ce8c74b7b6b06_d20220113_m051721_c001_v0001134_t0006") 2022/01/13 05:18:42 DEBUG : both3: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac6a0b5_d20220113_m051630_c001_v0001105_t0014") 2022/01/13 05:18:42 DEBUG : both4: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f11145f3723fe604f_d20220113_m051814_c001_v0001144_t0022") 2022/01/13 05:18:42 DEBUG : both4: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac6a8e6_d20220113_m051733_c001_v0001105_t0027") 2022/01/13 05:18:42 DEBUG : both4: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f109f4a2f686520df_d20220113_m051721_c001_v0001165_t0028") 2022/01/13 05:18:42 DEBUG : both4: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf1810ef_d20220113_m051634_c001_v0001033_t0021") 2022/01/13 05:18:42 DEBUG : both5: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1035defc481cb89c_d20220113_m051815_c001_v0001150_t0033") 2022/01/13 05:18:42 DEBUG : both5: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf18120e_d20220113_m051734_c001_v0001033_t0027") 2022/01/13 05:18:42 DEBUG : both5: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1067fb5d236130f5_d20220113_m051721_c001_v0001105_t0038") 2022/01/13 05:18:43 DEBUG : both5: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a01240_d20220113_m051636_c001_v0001131_t0058") 2022/01/13 05:18:43 DEBUG : both6: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f102fdc275ca4185e_d20220113_m051815_c001_v0001146_t0044") 2022/01/13 05:18:43 DEBUG : both6: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a013f6_d20220113_m051736_c001_v0001131_t0039") 2022/01/13 05:18:43 DEBUG : both6: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1010c460bcb3ddcc_d20220113_m051722_c001_v0001144_t0055") 2022/01/13 05:18:43 DEBUG : both6: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac6a208_d20220113_m051639_c001_v0001105_t0003") 2022/01/13 05:18:43 DEBUG : both7: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f101d48d12a34f0db_d20220113_m051817_c001_v0001105_t0016") 2022/01/13 05:18:43 DEBUG : both7: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac6a9ab_d20220113_m051738_c001_v0001105_t0028") 2022/01/13 05:18:43 DEBUG : both7: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1092860db7120971_d20220113_m051724_c001_v0001161_t0040") 2022/01/13 05:18:43 DEBUG : both7: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf18110c_d20220113_m051640_c001_v0001033_t0040") 2022/01/13 05:18:43 DEBUG : both8: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f110db33d54cbd62e_d20220113_m051818_c001_v0001005_t0039") 2022/01/13 05:18:43 DEBUG : both8: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf18121f_d20220113_m051739_c001_v0001033_t0015") 2022/01/13 05:18:43 DEBUG : both8: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1005e9753cc382dd_d20220113_m051724_c001_v0001165_t0002") 2022/01/13 05:18:43 DEBUG : both8: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a0126d_d20220113_m051641_c001_v0001131_t0045") 2022/01/13 05:18:43 DEBUG : both9: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1033948d01166735_d20220113_m051819_c001_v0001109_t0010") 2022/01/13 05:18:43 DEBUG : both9: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a01417_d20220113_m051743_c001_v0001131_t0019") 2022/01/13 05:18:43 DEBUG : both9: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f10627b2d93da5eb8_d20220113_m051724_c001_v0001117_t0043") 2022/01/13 05:18:43 DEBUG : both9: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac6a2ad_d20220113_m051643_c001_v0001105_t0051") 2022/01/13 05:18:43 DEBUG : c/non empty space: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f108e6cc68c3b7ff1_d20220113_m051024_c001_v0001131_t0024") 2022/01/13 05:18:43 DEBUG : c/non empty space: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180a21_d20220113_m051021_c001_v0001033_t0016") 2022/01/13 05:18:43 DEBUG : c/non empty space: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1036f52bcaf999c8_d20220113_m051020_c001_v0001097_t0042") 2022/01/13 05:18:43 DEBUG : c/non empty space: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180a01_d20220113_m051014_c001_v0001033_t0024") 2022/01/13 05:18:43 DEBUG : c/non empty space: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f117442b89e07835e_d20220113_m050938_c001_v0001134_t0010") 2022/01/13 05:18:44 DEBUG : c/non empty space: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf18093c_d20220113_m050933_c001_v0001033_t0033") 2022/01/13 05:18:44 DEBUG : check sum: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1186e43dff7cc52e_d20220113_m050920_c001_v0001105_t0023") 2022/01/13 05:18:44 DEBUG : check sum: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf1808ff_d20220113_m050919_c001_v0001033_t0053") 2022/01/13 05:18:44 DEBUG : dest/3: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f103901503aff21d4_d20220113_m051302_c001_v0001090_t0052") 2022/01/13 05:18:44 DEBUG : dest/3: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f110e9ec12bce9926_d20220113_m051301_c001_v0001098_t0006") 2022/01/13 05:18:44 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f10753486b6f5d5b6_d20220113_m051606_c001_v0001131_t0018") 2022/01/13 05:18:44 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f10587eedbdacc7e7_d20220113_m051602_c001_v0001090_t0043") 2022/01/13 05:18:44 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f116ea032280c0550_d20220113_m051600_c001_v0001117_t0025") 2022/01/13 05:18:44 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f10587eedbdacc7d0_d20220113_m051555_c001_v0001090_t0057") 2022/01/13 05:18:44 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f10042f0e058e4d23_d20220113_m051553_c001_v0001043_t0009") 2022/01/13 05:18:44 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180fe6_d20220113_m051543_c001_v0001033_t0036") 2022/01/13 05:18:44 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f110ef4122bc4e5a4_d20220113_m051539_c001_v0001117_t0005") 2022/01/13 05:18:44 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f115f47f82dbe7d77_d20220113_m051534_c001_v0001040_t0040") 2022/01/13 05:18:44 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f116809182eb33f01_d20220113_m051533_c001_v0001043_t0035") 2022/01/13 05:18:44 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f115f47f82dbe7d66_d20220113_m051528_c001_v0001040_t0018") 2022/01/13 05:18:44 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1010a2b251b1fb1d_d20220113_m051527_c001_v0001013_t0043") 2022/01/13 05:18:44 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180f72_d20220113_m051520_c001_v0001033_t0000") 2022/01/13 05:18:44 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f11600f323f875605_d20220113_m051515_c001_v0001105_t0048") 2022/01/13 05:18:44 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f102b9adbdb9e78b0_d20220113_m051505_c001_v0001043_t0031") 2022/01/13 05:18:44 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1190ee20c0d4909d_d20220113_m051504_c001_v0001154_t0000") 2022/01/13 05:18:45 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f102b9adbdb9e789a_d20220113_m051456_c001_v0001043_t0010") 2022/01/13 05:18:45 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f108857c278631179_d20220113_m051455_c001_v0001136_t0017") 2022/01/13 05:18:45 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a00e22_d20220113_m051449_c001_v0001131_t0017") 2022/01/13 05:18:45 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f10081dd545bc18ae_d20220113_m051447_c001_v0001109_t0018") 2022/01/13 05:18:45 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111355f482389e1f_d20220113_m051444_c001_v0001128_t0010") 2022/01/13 05:18:45 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1151c175d357c404_d20220113_m051442_c001_v0001039_t0009") 2022/01/13 05:18:45 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111355f482389e03_d20220113_m051436_c001_v0001128_t0025") 2022/01/13 05:18:45 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1050c7b97f7980b0_d20220113_m051435_c001_v0001022_t0028") 2022/01/13 05:18:45 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac68e4b_d20220113_m051428_c001_v0001105_t0036") 2022/01/13 05:18:45 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f109424515d97876c_d20220113_m051427_c001_v0001097_t0051") 2022/01/13 05:18:45 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f10543363e263be81_d20220113_m051421_c001_v0001037_t0001") 2022/01/13 05:18:45 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1067fb5d236119d5_d20220113_m051420_c001_v0001105_t0048") 2022/01/13 05:18:45 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f10543363e263be6a_d20220113_m051416_c001_v0001037_t0037") 2022/01/13 05:18:45 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f116ff9b2d3da19bd_d20220113_m051413_c001_v0001097_t0000") 2022/01/13 05:18:45 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180dfa_d20220113_m051403_c001_v0001033_t0019") 2022/01/13 05:18:45 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129720b540b71bc_d20220113_m051401_c001_v0001044_t0053") 2022/01/13 05:18:45 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f107150c010c90001_d20220113_m051357_c001_v0001097_t0008") 2022/01/13 05:18:45 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f104e0a22742bf17b_d20220113_m051356_c001_v0001105_t0033") 2022/01/13 05:18:45 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f107150c010c8ff6f_d20220113_m051349_c001_v0001097_t0039") 2022/01/13 05:18:45 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1107b80a4bcf249f_d20220113_m051348_c001_v0001165_t0029") 2022/01/13 05:18:46 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a00b8c_d20220113_m051339_c001_v0001131_t0035") 2022/01/13 05:18:46 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1151c5bef836bbe4_d20220113_m051337_c001_v0001131_t0055") 2022/01/13 05:18:46 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1050b710db646af8_d20220113_m051323_c001_v0001097_t0048") 2022/01/13 05:18:46 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f10289130e11e95a7_d20220113_m051322_c001_v0001150_t0003") 2022/01/13 05:18:46 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac68347_d20220113_m051312_c001_v0001105_t0009") 2022/01/13 05:18:46 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f10671df5d55ae61b_d20220113_m051310_c001_v0001018_t0039") 2022/01/13 05:18:46 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f10671df5d55ae619_d20220113_m051309_c001_v0001018_t0010") 2022/01/13 05:18:46 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f104f8d3cbda10346_d20220113_m051254_c001_v0001109_t0026") 2022/01/13 05:18:46 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a00982_d20220113_m051244_c001_v0001131_t0014") 2022/01/13 05:18:46 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1115f2f71a7156f4_d20220113_m051243_c001_v0001105_t0049") 2022/01/13 05:18:46 DEBUG : dst/one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1115f2f71a7156a8_d20220113_m051240_c001_v0001105_t0046") 2022/01/13 05:18:46 DEBUG : dst/one-2019-01-01: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1188d7d5919aef75_d20220113_m051607_c001_v0001042_t0045") 2022/01/13 05:18:46 DEBUG : dst/one-2019-01-01: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f11626095c9bc320b_d20220113_m051600_c001_v0001165_t0041") 2022/01/13 05:18:46 DEBUG : dst/one-2019-01-01: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111ad702e0247ec9_d20220113_m051552_c001_v0001097_t0054") 2022/01/13 05:18:46 DEBUG : dst/one.bak: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f10934a807dab20e3_d20220113_m051540_c001_v0001042_t0041") 2022/01/13 05:18:46 DEBUG : dst/one.bak: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f11076ad9815c2dbd_d20220113_m051533_c001_v0001150_t0012") 2022/01/13 05:18:46 DEBUG : dst/one.bak: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1128e6f841e9bdc2_d20220113_m051526_c001_v0001137_t0021") 2022/01/13 05:18:46 DEBUG : dst/one.bak: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f113ea5ba52694207_d20220113_m051516_c001_v0001131_t0058") 2022/01/13 05:18:46 DEBUG : dst/one.bak: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f107e67e119060d49_d20220113_m051503_c001_v0001041_t0049") 2022/01/13 05:18:46 DEBUG : dst/one.bak: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f115ac477b77fb301_d20220113_m051455_c001_v0001105_t0010") 2022/01/13 05:18:46 DEBUG : dst/three: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1111e2945fa705d1_d20220113_m051337_c001_v0001113_t0053") 2022/01/13 05:18:46 DEBUG : dst/three: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f10671df5d55ae62d_d20220113_m051332_c001_v0001018_t0040") 2022/01/13 05:18:47 DEBUG : dst/three-2019-01-01.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f115a12c87e802b11_d20220113_m051608_c001_v0001044_t0001") 2022/01/13 05:18:47 DEBUG : dst/three-2019-01-01.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1134679437a59c35_d20220113_m051604_c001_v0001037_t0016") 2022/01/13 05:18:47 DEBUG : dst/three-2019-01-01.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f105be24ed0427297_d20220113_m051558_c001_v0001093_t0020") 2022/01/13 05:18:47 DEBUG : dst/three.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f10483e791694627c_d20220113_m051609_c001_v0001037_t0034") 2022/01/13 05:18:47 DEBUG : dst/three.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f10587eedbdacc7f0_d20220113_m051605_c001_v0001090_t0011") 2022/01/13 05:18:47 DEBUG : dst/three.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f101ca6492ee5ce66_d20220113_m051604_c001_v0001003_t0001") 2022/01/13 05:18:47 DEBUG : dst/three.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f10587eedbdacc7de_d20220113_m051559_c001_v0001090_t0042") 2022/01/13 05:18:47 DEBUG : dst/three.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1080c7d51f028855_d20220113_m051558_c001_v0001161_t0023") 2022/01/13 05:18:47 DEBUG : dst/three.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a0104c_d20220113_m051546_c001_v0001131_t0052") 2022/01/13 05:18:47 DEBUG : dst/three.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f113dfbfb9faa32be_d20220113_m051541_c001_v0001098_t0019") 2022/01/13 05:18:47 DEBUG : dst/three.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f115f47f82dbe7d8d_d20220113_m051539_c001_v0001040_t0027") 2022/01/13 05:18:47 DEBUG : dst/three.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f11012dfc3c580f9d_d20220113_m051538_c001_v0001105_t0016") 2022/01/13 05:18:47 DEBUG : dst/three.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f115f47f82dbe7d70_d20220113_m051531_c001_v0001040_t0009") 2022/01/13 05:18:47 DEBUG : dst/three.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f114590969a6b6cc9_d20220113_m051530_c001_v0001109_t0008") 2022/01/13 05:18:47 DEBUG : dst/three.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a00f70_d20220113_m051523_c001_v0001131_t0002") 2022/01/13 05:18:47 DEBUG : dst/three.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f103a0cb3674fadb8_d20220113_m051506_c001_v0001032_t0058") 2022/01/13 05:18:47 DEBUG : dst/three.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a00e9a_d20220113_m051502_c001_v0001131_t0033") 2022/01/13 05:18:47 DEBUG : dst/three.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f115a769bb2d04262_d20220113_m051459_c001_v0001117_t0054") 2022/01/13 05:18:47 DEBUG : dst/three.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac69221_d20220113_m051451_c001_v0001105_t0003") 2022/01/13 05:18:47 DEBUG : dst/three.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f11726962ea6cb8e8_d20220113_m051445_c001_v0001146_t0043") 2022/01/13 05:18:48 DEBUG : dst/three.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac6902d_d20220113_m051440_c001_v0001105_t0025") 2022/01/13 05:18:48 DEBUG : dst/three.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f109ae94d156f45c0_d20220113_m051437_c001_v0001105_t0001") 2022/01/13 05:18:48 DEBUG : dst/three.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180e71_d20220113_m051431_c001_v0001033_t0012") 2022/01/13 05:18:48 DEBUG : dst/three.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f119696fb1b9a6c9e_d20220113_m051423_c001_v0001097_t0014") 2022/01/13 05:18:48 DEBUG : dst/three.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180e3a_d20220113_m051419_c001_v0001033_t0004") 2022/01/13 05:18:48 DEBUG : dst/three.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1123a08f95aec244_d20220113_m051418_c001_v0001165_t0034") 2022/01/13 05:18:48 DEBUG : dst/three.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a00c90_d20220113_m051408_c001_v0001131_t0036") 2022/01/13 05:18:48 DEBUG : dst/three.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f101d48d12a34d25e_d20220113_m051358_c001_v0001105_t0023") 2022/01/13 05:18:48 DEBUG : dst/three.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a00c09_d20220113_m051352_c001_v0001131_t0045") 2022/01/13 05:18:48 DEBUG : dst/three.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f112bd56c8742543e_d20220113_m051351_c001_v0001011_t0019") 2022/01/13 05:18:48 DEBUG : dst/three.txt: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac687f9_d20220113_m051343_c001_v0001105_t0009") 2022/01/13 05:18:48 DEBUG : dst/three.txt.bak: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f11797d79e1510321_d20220113_m051541_c001_v0001105_t0022") 2022/01/13 05:18:48 DEBUG : dst/three.txt.bak: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f107b819eba9ae281_d20220113_m051537_c001_v0001098_t0005") 2022/01/13 05:18:48 DEBUG : dst/three.txt.bak: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1067fb5d236122b5_d20220113_m051529_c001_v0001105_t0001") 2022/01/13 05:18:48 DEBUG : dst/three.txt.bak: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f115a769bb2d0433f_d20220113_m051517_c001_v0001117_t0029") 2022/01/13 05:18:48 DEBUG : dst/three.txt.bak: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f107150c010c904a7_d20220113_m051506_c001_v0001097_t0048") 2022/01/13 05:18:48 DEBUG : dst/three.txt.bak: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f103c1999389fd4fb_d20220113_m051458_c001_v0001105_t0000") 2022/01/13 05:18:48 DEBUG : dst/two: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f11012dfc3c5813aa_d20220113_m051610_c001_v0001105_t0036") 2022/01/13 05:18:48 DEBUG : dst/two: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac699e2_d20220113_m051544_c001_v0001105_t0005") 2022/01/13 05:18:48 DEBUG : dst/two: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f10587eedbdacc7b6_d20220113_m051542_c001_v0001090_t0043") 2022/01/13 05:18:49 DEBUG : dst/two: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac696a8_d20220113_m051521_c001_v0001105_t0046") 2022/01/13 05:18:49 DEBUG : dst/two: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1137b0cfad0f0402_d20220113_m051518_c001_v0001109_t0019") 2022/01/13 05:18:49 DEBUG : dst/two: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180ee3_d20220113_m051450_c001_v0001033_t0030") 2022/01/13 05:18:49 DEBUG : dst/two: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f112dd91e814804d3_d20220113_m051448_c001_v0001109_t0026") 2022/01/13 05:18:49 DEBUG : dst/two: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a00d46_d20220113_m051430_c001_v0001131_t0025") 2022/01/13 05:18:49 DEBUG : dst/two: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f100ce1ab60945b2e_d20220113_m051427_c001_v0001105_t0034") 2022/01/13 05:18:49 DEBUG : dst/two: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac68b38_d20220113_m051406_c001_v0001105_t0036") 2022/01/13 05:18:49 DEBUG : dst/two: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1005e9753cc36f40_d20220113_m051402_c001_v0001165_t0037") 2022/01/13 05:18:49 DEBUG : dst/two: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180da0_d20220113_m051340_c001_v0001033_t0004") 2022/01/13 05:18:49 DEBUG : dst/two: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1137a18268f179e2_d20220113_m051338_c001_v0001150_t0025") 2022/01/13 05:18:49 DEBUG : dst/two: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f105926d518780abf_d20220113_m051328_c001_v0001120_t0048") 2022/01/13 05:18:49 DEBUG : dst/two: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f119ce1a3eaa6d173_d20220113_m051254_c001_v0001105_t0018") 2022/01/13 05:18:49 DEBUG : dst/two: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1115f2f71a71580e_d20220113_m051252_c001_v0001105_t0051") 2022/01/13 05:18:49 DEBUG : empty space: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f102bb1c81e454a00_d20220113_m051224_c001_v0001165_t0008") 2022/01/13 05:18:49 DEBUG : empty space: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a00895_d20220113_m051218_c001_v0001131_t0032") 2022/01/13 05:18:49 DEBUG : empty space: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f114793c445279a32_d20220113_m051210_c001_v0001042_t0029") 2022/01/13 05:18:49 DEBUG : empty space: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a007c4_d20220113_m051156_c001_v0001131_t0014") 2022/01/13 05:18:49 DEBUG : empty space: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f107d0717c63c6df7_d20220113_m051144_c001_v0001136_t0027") 2022/01/13 05:18:49 DEBUG : empty space: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a00700_d20220113_m051138_c001_v0001131_t0052") 2022/01/13 05:18:49 DEBUG : empty space: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111b55150ee54121_d20220113_m051052_c001_v0001165_t0029") 2022/01/13 05:18:49 DEBUG : empty space: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180a96_d20220113_m051048_c001_v0001033_t0001") 2022/01/13 05:18:50 DEBUG : empty space: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f107e67e119060b53_d20220113_m051046_c001_v0001041_t0049") 2022/01/13 05:18:50 DEBUG : empty space: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180a8d_d20220113_m051045_c001_v0001033_t0018") 2022/01/13 05:18:50 DEBUG : empty space: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f110bf58af675c2d2_d20220113_m051039_c001_v0001146_t0050") 2022/01/13 05:18:50 DEBUG : empty space: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180a62_d20220113_m051032_c001_v0001033_t0047") 2022/01/13 05:18:50 DEBUG : empty space: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f10875e538ab8f0c1_d20220113_m051027_c001_v0001105_t0040") 2022/01/13 05:18:50 DEBUG : empty space: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180a40_d20220113_m051026_c001_v0001033_t0015") 2022/01/13 05:18:50 DEBUG : empty space: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f11572c20f11c3a61_d20220113_m051010_c001_v0001150_t0005") 2022/01/13 05:18:50 DEBUG : empty space: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf1809e1_d20220113_m051008_c001_v0001033_t0026") 2022/01/13 05:18:50 DEBUG : empty space: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f101d48d12a34b5f6_d20220113_m051006_c001_v0001105_t0008") 2022/01/13 05:18:50 DEBUG : empty space: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf1809d3_d20220113_m051005_c001_v0001033_t0017") 2022/01/13 05:18:50 DEBUG : empty space: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f103901503aff2086_d20220113_m050949_c001_v0001090_t0030") 2022/01/13 05:18:50 DEBUG : empty space: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf18098b_d20220113_m050947_c001_v0001033_t0036") 2022/01/13 05:18:50 DEBUG : empty space: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1075e0b34de7da16_d20220113_m050944_c001_v0001009_t0006") 2022/01/13 05:18:50 DEBUG : empty space: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf18096d_d20220113_m050943_c001_v0001033_t0004") 2022/01/13 05:18:50 DEBUG : empty space: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f10567ad75866ca4c_d20220113_m050942_c001_v0001105_t0014") 2022/01/13 05:18:50 DEBUG : empty space: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1059e0c507111ee4_d20220113_m050941_c001_v0001012_t0036") 2022/01/13 05:18:50 DEBUG : empty space: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180959_d20220113_m050938_c001_v0001033_t0028") 2022/01/13 05:18:50 DEBUG : enormous: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1132b4ec26f22da3_d20220113_m051050_c001_v0001144_t0017") 2022/01/13 05:18:51 DEBUG : enormous: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180a98_d20220113_m051049_c001_v0001033_t0037") 2022/01/13 05:18:51 DEBUG : existing: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f104a6d3430468289_d20220113_m051618_c001_v0001137_t0013") 2022/01/13 05:18:51 DEBUG : existing: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a0118d_d20220113_m051617_c001_v0001131_t0006") 2022/01/13 05:18:51 DEBUG : existing: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f109ae94d156f2d44_d20220113_m051135_c001_v0001105_t0054") 2022/01/13 05:18:51 DEBUG : existing: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a006d3_d20220113_m051134_c001_v0001131_t0021") 2022/01/13 05:18:51 DEBUG : existing: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f10081dd545bc063b_d20220113_m050932_c001_v0001109_t0039") 2022/01/13 05:18:51 DEBUG : existing: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf18092b_d20220113_m050930_c001_v0001033_t0041") 2022/01/13 05:18:51 DEBUG : existing: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f114ee64f3c69f671_d20220113_m050928_c001_v0001105_t0016") 2022/01/13 05:18:51 DEBUG : existing: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf18091f_d20220113_m050927_c001_v0001033_t0011") 2022/01/13 05:18:51 DEBUG : existing: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180919_d20220113_m050926_c001_v0001033_t0004") 2022/01/13 05:18:51 DEBUG : existing-b: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f119ce1a3eaa6c669_d20220113_m051136_c001_v0001105_t0009") 2022/01/13 05:18:51 DEBUG : existing-b: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180b62_d20220113_m051134_c001_v0001033_t0032") 2022/01/13 05:18:51 DEBUG : five: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f113745cef21d5c19_d20220113_m051100_c001_v0001146_t0051") 2022/01/13 05:18:51 DEBUG : five: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180ab7_d20220113_m051057_c001_v0001033_t0047") 2022/01/13 05:18:51 DEBUG : foo: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f115a769bb2d0328b_d20220113_m050947_c001_v0001117_t0055") 2022/01/13 05:18:51 DEBUG : foo: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180984_d20220113_m050946_c001_v0001033_t0033") 2022/01/13 05:18:51 DEBUG : foo: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf18097e_d20220113_m050945_c001_v0001033_t0048") 2022/01/13 05:18:51 DEBUG : four: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f110882fa3de09d00_d20220113_m051102_c001_v0001029_t0013") 2022/01/13 05:18:51 DEBUG : four: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac66fc1_d20220113_m051058_c001_v0001105_t0024") 2022/01/13 05:18:51 DEBUG : four: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180ab4_d20220113_m051056_c001_v0001033_t0040") 2022/01/13 05:18:52 DEBUG : hello world2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f104966f8bdfdc488_d20220113_m050859_c001_v0001042_t0054") 2022/01/13 05:18:52 DEBUG : hello world2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180887_d20220113_m050857_c001_v0001033_t0009") 2022/01/13 05:18:52 DEBUG : ignore-size: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f103c1999389fab5a_d20220113_m050925_c001_v0001105_t0043") 2022/01/13 05:18:52 DEBUG : ignore-size: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180914_d20220113_m050923_c001_v0001033_t0005") 2022/01/13 05:18:52 DEBUG : nested/sub dir/file: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1138f19b385ee39b_d20220113_m051132_c001_v0001043_t0059") 2022/01/13 05:18:52 DEBUG : nested/sub dir/file: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180b50_d20220113_m051130_c001_v0001033_t0025") 2022/01/13 05:18:52 DEBUG : nested/sub dir/file: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f101beb167a501a17_d20220113_m051129_c001_v0001150_t0051") 2022/01/13 05:18:52 DEBUG : nested/sub dir/file: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180b41_d20220113_m051128_c001_v0001033_t0054") 2022/01/13 05:18:52 DEBUG : one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f104045d543a244db_d20220113_m051103_c001_v0001001_t0024") 2022/01/13 05:18:52 DEBUG : one: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180aa0_d20220113_m051052_c001_v0001033_t0026") 2022/01/13 05:18:52 DEBUG : only0: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f118402738d114d7e_d20220113_m051820_c001_v0001091_t0033") 2022/01/13 05:18:52 DEBUG : only0: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf18129f_d20220113_m051803_c001_v0001033_t0014") 2022/01/13 05:18:52 DEBUG : only0: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf1811e3_d20220113_m051726_c001_v0001033_t0043") 2022/01/13 05:18:52 DEBUG : only0: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f118e1fbaddb2c4f2_d20220113_m051700_c001_v0001144_t0036") 2022/01/13 05:18:52 DEBUG : only0: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a011dc_d20220113_m051624_c001_v0001131_t0053") 2022/01/13 05:18:52 DEBUG : only1: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f118e819f460215ea_d20220113_m051820_c001_v0001137_t0047") 2022/01/13 05:18:52 DEBUG : only1: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac6ace9_d20220113_m051803_c001_v0001105_t0024") 2022/01/13 05:18:52 DEBUG : only1: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a013b7_d20220113_m051728_c001_v0001131_t0031") 2022/01/13 05:18:52 DEBUG : only1: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f118c0a13ce79549c_d20220113_m051703_c001_v0001039_t0043") 2022/01/13 05:18:53 DEBUG : only1: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac6a02b_d20220113_m051626_c001_v0001105_t0041") 2022/01/13 05:18:53 DEBUG : only10: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f11145f3723fe606c_d20220113_m051822_c001_v0001144_t0034") 2022/01/13 05:18:53 DEBUG : only10: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a014ca_d20220113_m051803_c001_v0001131_t0055") 2022/01/13 05:18:53 DEBUG : only10: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a01428_d20220113_m051745_c001_v0001131_t0000") 2022/01/13 05:18:53 DEBUG : only10: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f11389e33e0d37877_d20220113_m051700_c001_v0001011_t0009") 2022/01/13 05:18:53 DEBUG : only10: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac6a302_d20220113_m051645_c001_v0001105_t0045") 2022/01/13 05:18:53 DEBUG : only11: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1047cceec7ed1610_d20220113_m051822_c001_v0001009_t0029") 2022/01/13 05:18:53 DEBUG : only11: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f107a009d3a0dea24_d20220113_m051804_c001_v0001105_t0010") 2022/01/13 05:18:53 DEBUG : only11: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac6aab7_d20220113_m051747_c001_v0001105_t0050") 2022/01/13 05:18:53 DEBUG : only11: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f101d48d12a34e90d_d20220113_m051703_c001_v0001105_t0053") 2022/01/13 05:18:53 DEBUG : only11: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf181138_d20220113_m051647_c001_v0001033_t0035") 2022/01/13 05:18:53 DEBUG : only12: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1024e49d62adb119_d20220113_m051822_c001_v0001113_t0001") 2022/01/13 05:18:53 DEBUG : only12: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a014ce_d20220113_m051803_c001_v0001131_t0027") 2022/01/13 05:18:53 DEBUG : only12: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf18124d_d20220113_m051748_c001_v0001033_t0014") 2022/01/13 05:18:53 DEBUG : only12: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f10874d26d2c8f71e_d20220113_m051704_c001_v0001130_t0049") 2022/01/13 05:18:53 DEBUG : only12: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a012ae_d20220113_m051649_c001_v0001131_t0030") 2022/01/13 05:18:53 DEBUG : only13: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1114bf92950327a1_d20220113_m051823_c001_v0001157_t0014") 2022/01/13 05:18:53 DEBUG : only13: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf1812a3_d20220113_m051803_c001_v0001033_t0006") 2022/01/13 05:18:53 DEBUG : only13: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a01454_d20220113_m051749_c001_v0001131_t0007") 2022/01/13 05:18:53 DEBUG : only13: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1006f70844767f3b_d20220113_m051701_c001_v0001040_t0032") 2022/01/13 05:18:53 DEBUG : only13: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac6a3dd_d20220113_m051650_c001_v0001105_t0019") 2022/01/13 05:18:54 DEBUG : only14: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf181303_d20220113_m051824_c001_v0001033_t0058") 2022/01/13 05:18:54 DEBUG : only14: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac6acf7_d20220113_m051803_c001_v0001105_t0005") 2022/01/13 05:18:54 DEBUG : only14: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac6ab26_d20220113_m051750_c001_v0001105_t0044") 2022/01/13 05:18:54 DEBUG : only14: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f119a5ced73cfbedc_d20220113_m051701_c001_v0001039_t0011") 2022/01/13 05:18:54 DEBUG : only14: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf181153_d20220113_m051652_c001_v0001033_t0033") 2022/01/13 05:18:54 DEBUG : only15: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1056c5a5d9e4411d_d20220113_m051825_c001_v0001044_t0021") 2022/01/13 05:18:54 DEBUG : only15: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a014d4_d20220113_m051804_c001_v0001131_t0012") 2022/01/13 05:18:54 DEBUG : only15: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf181275_d20220113_m051753_c001_v0001033_t0027") 2022/01/13 05:18:54 DEBUG : only15: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f112dd91e81480bff_d20220113_m051702_c001_v0001109_t0014") 2022/01/13 05:18:54 DEBUG : only15: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a012cd_d20220113_m051653_c001_v0001131_t0017") 2022/01/13 05:18:54 DEBUG : only16: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac6afaf_d20220113_m051825_c001_v0001105_t0021") 2022/01/13 05:18:54 DEBUG : only16: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac6ad0f_d20220113_m051804_c001_v0001105_t0059") 2022/01/13 05:18:54 DEBUG : only16: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a01486_d20220113_m051754_c001_v0001131_t0007") 2022/01/13 05:18:54 DEBUG : only16: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f110ad2a418740ce3_d20220113_m051702_c001_v0001109_t0007") 2022/01/13 05:18:54 DEBUG : only16: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac6a486_d20220113_m051654_c001_v0001105_t0032") 2022/01/13 05:18:54 DEBUG : only17: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f101553daa8183e04_d20220113_m051826_c001_v0001131_t0034") 2022/01/13 05:18:54 DEBUG : only17: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a014d7_d20220113_m051804_c001_v0001131_t0019") 2022/01/13 05:18:54 DEBUG : only17: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac6ac06_d20220113_m051756_c001_v0001105_t0034") 2022/01/13 05:18:54 DEBUG : only17: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f112025f2bb969f07_d20220113_m051701_c001_v0001019_t0038") 2022/01/13 05:18:54 DEBUG : only17: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf18116a_d20220113_m051655_c001_v0001033_t0016") 2022/01/13 05:18:55 DEBUG : only18: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f109ae94d156f625a_d20220113_m051826_c001_v0001105_t0003") 2022/01/13 05:18:55 DEBUG : only18: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f107a009d3a0dea37_d20220113_m051804_c001_v0001105_t0054") 2022/01/13 05:18:55 DEBUG : only18: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf18128b_d20220113_m051758_c001_v0001033_t0046") 2022/01/13 05:18:55 DEBUG : only18: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1115f2f71a717729_d20220113_m051705_c001_v0001105_t0030") 2022/01/13 05:18:55 DEBUG : only18: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a012ed_d20220113_m051657_c001_v0001131_t0044") 2022/01/13 05:18:55 DEBUG : only19: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f114608881077ef68_d20220113_m051827_c001_v0001137_t0015") 2022/01/13 05:18:55 DEBUG : only19: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a014df_d20220113_m051805_c001_v0001131_t0009") 2022/01/13 05:18:55 DEBUG : only19: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a014c3_d20220113_m051802_c001_v0001131_t0018") 2022/01/13 05:18:55 DEBUG : only19: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1109b595f1ca5aed_d20220113_m051700_c001_v0001008_t0036") 2022/01/13 05:18:55 DEBUG : only19: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac6a508_d20220113_m051658_c001_v0001105_t0019") 2022/01/13 05:18:55 DEBUG : only2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1023be88de58f682_d20220113_m051828_c001_v0001105_t0018") 2022/01/13 05:18:55 DEBUG : only2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac6ad21_d20220113_m051805_c001_v0001105_t0005") 2022/01/13 05:18:55 DEBUG : only2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac6a8a9_d20220113_m051731_c001_v0001105_t0029") 2022/01/13 05:18:55 DEBUG : only2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f113472c8b83487ae_d20220113_m051702_c001_v0001117_t0050") 2022/01/13 05:18:55 DEBUG : only2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf1810d1_d20220113_m051628_c001_v0001033_t0007") 2022/01/13 05:18:55 DEBUG : only3: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f11539374ab4fc16f_d20220113_m051829_c001_v0001032_t0036") 2022/01/13 05:18:55 DEBUG : only3: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f107a009d3a0dea4c_d20220113_m051805_c001_v0001105_t0000") 2022/01/13 05:18:55 DEBUG : only3: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf181203_d20220113_m051732_c001_v0001033_t0003") 2022/01/13 05:18:55 DEBUG : only3: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1056fafa89df936c_d20220113_m051700_c001_v0001150_t0029") 2022/01/13 05:18:56 DEBUG : only3: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a0122e_d20220113_m051633_c001_v0001131_t0038") 2022/01/13 05:18:56 DEBUG : only4: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f118352c284213b5a_d20220113_m051829_c001_v0001161_t0044") 2022/01/13 05:18:56 DEBUG : only4: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a014e1_d20220113_m051805_c001_v0001131_t0012") 2022/01/13 05:18:56 DEBUG : only4: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a013e3_d20220113_m051734_c001_v0001131_t0023") 2022/01/13 05:18:56 DEBUG : only4: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f114ee64f3c6a342b_d20220113_m051700_c001_v0001105_t0003") 2022/01/13 05:18:56 DEBUG : only4: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac6a135_d20220113_m051634_c001_v0001105_t0044") 2022/01/13 05:18:56 DEBUG : only5: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111c179e1ac6de65_d20220113_m051830_c001_v0001093_t0040") 2022/01/13 05:18:56 DEBUG : only5: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f107a009d3a0dea56_d20220113_m051805_c001_v0001105_t0058") 2022/01/13 05:18:56 DEBUG : only5: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac6a94a_d20220113_m051735_c001_v0001105_t0034") 2022/01/13 05:18:56 DEBUG : only5: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1186e43dff7cfd4e_d20220113_m051704_c001_v0001105_t0059") 2022/01/13 05:18:56 DEBUG : only5: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf1810fe_d20220113_m051637_c001_v0001033_t0053") 2022/01/13 05:18:56 DEBUG : only6: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f105926d518780f22_d20220113_m051830_c001_v0001120_t0018") 2022/01/13 05:18:56 DEBUG : only6: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac6ad2c_d20220113_m051805_c001_v0001105_t0015") 2022/01/13 05:18:56 DEBUG : only6: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf181219_d20220113_m051737_c001_v0001033_t0006") 2022/01/13 05:18:56 DEBUG : only6: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f100cbe8240833020_d20220113_m051705_c001_v0001113_t0003") 2022/01/13 05:18:56 DEBUG : only6: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a01262_d20220113_m051640_c001_v0001131_t0051") 2022/01/13 05:18:56 DEBUG : only7: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f119671ce1369af1a_d20220113_m051831_c001_v0001033_t0048") 2022/01/13 05:18:56 DEBUG : only7: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a014e8_d20220113_m051806_c001_v0001131_t0045") 2022/01/13 05:18:56 DEBUG : only7: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a013fd_d20220113_m051739_c001_v0001131_t0030") 2022/01/13 05:18:56 DEBUG : only7: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f113ea5ba526945cb_d20220113_m051703_c001_v0001131_t0043") 2022/01/13 05:18:57 DEBUG : only7: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac6a247_d20220113_m051640_c001_v0001105_t0011") 2022/01/13 05:18:57 DEBUG : only8: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f10627b2d93da625c_d20220113_m051834_c001_v0001117_t0020") 2022/01/13 05:18:57 DEBUG : only8: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf1812aa_d20220113_m051806_c001_v0001033_t0020") 2022/01/13 05:18:57 DEBUG : only8: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac6aa2b_d20220113_m051742_c001_v0001105_t0018") 2022/01/13 05:18:57 DEBUG : only8: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f10140f5efa31d897_d20220113_m051701_c001_v0001161_t0052") 2022/01/13 05:18:57 DEBUG : only8: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf18111b_d20220113_m051642_c001_v0001033_t0040") 2022/01/13 05:18:57 DEBUG : only9: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f101d48d12a34f295_d20220113_m051835_c001_v0001105_t0003") 2022/01/13 05:18:57 DEBUG : only9: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a014ec_d20220113_m051806_c001_v0001131_t0033") 2022/01/13 05:18:57 DEBUG : only9: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf181234_d20220113_m051743_c001_v0001033_t0052") 2022/01/13 05:18:57 DEBUG : only9: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1188851593a19bad_d20220113_m051705_c001_v0001033_t0038") 2022/01/13 05:18:57 DEBUG : only9: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a0127e_d20220113_m051643_c001_v0001131_t0003") 2022/01/13 05:18:57 DEBUG : potato: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f115a1b2a80222586_d20220113_m051122_c001_v0001109_t0000") 2022/01/13 05:18:57 DEBUG : potato: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac67251_d20220113_m051117_c001_v0001105_t0020") 2022/01/13 05:18:57 DEBUG : potato: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f118911dcda474b5c_d20220113_m051116_c001_v0001153_t0003") 2022/01/13 05:18:57 DEBUG : potato: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180af7_d20220113_m051112_c001_v0001033_t0045") 2022/01/13 05:18:57 DEBUG : potato: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1115f2f71a714bb7_d20220113_m051109_c001_v0001105_t0041") 2022/01/13 05:18:57 DEBUG : potato: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180add_d20220113_m051105_c001_v0001033_t0056") 2022/01/13 05:18:57 DEBUG : potato: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1111e2945fa70058_d20220113_m051042_c001_v0001113_t0001") 2022/01/13 05:18:58 DEBUG : potato: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180a7e_d20220113_m051041_c001_v0001033_t0049") 2022/01/13 05:18:58 DEBUG : potato: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f11768623a7a29834_d20220113_m051037_c001_v0001109_t0037") 2022/01/13 05:18:58 DEBUG : potato: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180a54_d20220113_m051029_c001_v0001033_t0036") 2022/01/13 05:18:58 DEBUG : potato: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f118e76f29898372b_d20220113_m051027_c001_v0001031_t0014") 2022/01/13 05:18:58 DEBUG : potato: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180a3a_d20220113_m051025_c001_v0001033_t0003") 2022/01/13 05:18:58 DEBUG : potato: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f109bc2b16b79a518_d20220113_m051009_c001_v0001113_t0016") 2022/01/13 05:18:58 DEBUG : potato: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf1809dd_d20220113_m051007_c001_v0001033_t0051") 2022/01/13 05:18:58 DEBUG : potato: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f109bc2b16b79a50a_d20220113_m051006_c001_v0001113_t0017") 2022/01/13 05:18:58 DEBUG : potato: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf1809cd_d20220113_m051004_c001_v0001033_t0003") 2022/01/13 05:18:58 DEBUG : potato: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f109538113c353179_d20220113_m051003_c001_v0001037_t0015") 2022/01/13 05:18:58 DEBUG : potato: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf1809ba_d20220113_m051000_c001_v0001033_t0023") 2022/01/13 05:18:58 DEBUG : potato: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf1809b7_d20220113_m050959_c001_v0001033_t0018") 2022/01/13 05:18:58 DEBUG : potato: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1119e88a7488e7b5_d20220113_m050958_c001_v0001117_t0051") 2022/01/13 05:18:58 DEBUG : potato: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf1809ab_d20220113_m050957_c001_v0001033_t0014") 2022/01/13 05:18:58 DEBUG : potato: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf1809a4_d20220113_m050956_c001_v0001033_t0022") 2022/01/13 05:18:58 DEBUG : potato: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f115ac477b77f85a1_d20220113_m050952_c001_v0001105_t0018") 2022/01/13 05:18:58 DEBUG : potato: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180992_d20220113_m050948_c001_v0001033_t0053") 2022/01/13 05:18:58 DEBUG : potato2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f118788dfb41a2d51_d20220113_m051237_c001_v0001044_t0032") 2022/01/13 05:18:58 DEBUG : potato2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac67dac_d20220113_m051236_c001_v0001105_t0034") 2022/01/13 05:18:58 DEBUG : potato2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f106eb339080a7ffd_d20220113_m051224_c001_v0001109_t0014") 2022/01/13 05:18:58 DEBUG : potato2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac67aa8_d20220113_m051215_c001_v0001105_t0039") 2022/01/13 05:18:59 DEBUG : potato2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f11803dce5e7ab768_d20220113_m051204_c001_v0001120_t0040") 2022/01/13 05:18:59 DEBUG : potato2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac677d4_d20220113_m051154_c001_v0001105_t0058") 2022/01/13 05:18:59 DEBUG : potato2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f108857c278630f5b_d20220113_m051145_c001_v0001136_t0000") 2022/01/13 05:18:59 DEBUG : potato2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac6755d_d20220113_m051138_c001_v0001105_t0025") 2022/01/13 05:18:59 DEBUG : potato2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f113f7a07d2b7ecbd_d20220113_m051051_c001_v0001136_t0027") 2022/01/13 05:18:59 DEBUG : potato2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180a92_d20220113_m051048_c001_v0001033_t0041") 2022/01/13 05:18:59 DEBUG : potato2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1023be88de58bfdc_d20220113_m051047_c001_v0001105_t0018") 2022/01/13 05:18:59 DEBUG : potato2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180a89_d20220113_m051044_c001_v0001033_t0014") 2022/01/13 05:18:59 DEBUG : potato2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f109ae94d156f2767_d20220113_m051043_c001_v0001105_t0026") 2022/01/13 05:18:59 DEBUG : potato2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180a80_d20220113_m051041_c001_v0001033_t0009") 2022/01/13 05:18:59 DEBUG : potato2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1115f2f71a714969_d20220113_m051039_c001_v0001105_t0009") 2022/01/13 05:18:59 DEBUG : potato2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180a6f_d20220113_m051038_c001_v0001033_t0022") 2022/01/13 05:18:59 DEBUG : potato2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f110e4ec762914613_d20220113_m051028_c001_v0001137_t0027") 2022/01/13 05:18:59 DEBUG : potato2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180a44_d20220113_m051027_c001_v0001033_t0007") 2022/01/13 05:18:59 DEBUG : potato2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f105748d84eed28fa_d20220113_m051010_c001_v0001015_t0013") 2022/01/13 05:18:59 DEBUG : potato2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf1809e5_d20220113_m051009_c001_v0001033_t0041") 2022/01/13 05:18:59 DEBUG : potato2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac66080_d20220113_m050903_c001_v0001105_t0031") 2022/01/13 05:18:59 DEBUG : potato2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf18089e_d20220113_m050902_c001_v0001033_t0004") 2022/01/13 05:18:59 DEBUG : potato2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f115fe84a3e47184b_d20220113_m050901_c001_v0001144_t0001") 2022/01/13 05:18:59 DEBUG : potato2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180895_d20220113_m050900_c001_v0001033_t0037") 2022/01/13 05:18:59 DEBUG : potato3: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f115a12c87e8025fb_d20220113_m051224_c001_v0001044_t0014") 2022/01/13 05:19:00 DEBUG : potato3: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180c26_d20220113_m051219_c001_v0001033_t0002") 2022/01/13 05:19:00 DEBUG : potato3: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f10479b04486fc4d1_d20220113_m051203_c001_v0001098_t0024") 2022/01/13 05:19:00 DEBUG : potato3: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180bce_d20220113_m051156_c001_v0001033_t0044") 2022/01/13 05:19:00 DEBUG : potato3: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f118896dae4866a3b_d20220113_m051146_c001_v0001145_t0055") 2022/01/13 05:19:00 DEBUG : potato3: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180b83_d20220113_m051139_c001_v0001033_t0045") 2022/01/13 05:19:00 DEBUG : pre-dest1/1: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1130195366a3e6d5_d20220113_m051303_c001_v0001113_t0023") 2022/01/13 05:19:00 DEBUG : pre-dest1/1: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a009e3_d20220113_m051256_c001_v0001131_t0008") 2022/01/13 05:19:00 DEBUG : pre-dest2/2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f11012dfc3c57f970_d20220113_m051304_c001_v0001105_t0036") 2022/01/13 05:19:00 DEBUG : pre-dest2/2: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180cd3_d20220113_m051256_c001_v0001033_t0035") 2022/01/13 05:19:00 DEBUG : sizeonly: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f113745cef21d58bc_d20220113_m050922_c001_v0001146_t0014") 2022/01/13 05:19:00 DEBUG : sizeonly: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf18090c_d20220113_m050921_c001_v0001033_t0011") 2022/01/13 05:19:00 DEBUG : sub dir/hello world: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1067fb5d236104cb_d20220113_m051132_c001_v0001105_t0011") 2022/01/13 05:19:00 DEBUG : sub dir/hello world: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac6744e_d20220113_m051131_c001_v0001105_t0053") 2022/01/13 05:19:00 DEBUG : sub dir/hello world: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111b55150ee542d6_d20220113_m051130_c001_v0001165_t0005") 2022/01/13 05:19:00 DEBUG : sub dir/hello world: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a0069f_d20220113_m051129_c001_v0001131_t0014") 2022/01/13 05:19:00 DEBUG : sub dir/hello world: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f113745cef21d589f_d20220113_m050919_c001_v0001146_t0051") 2022/01/13 05:19:00 DEBUG : sub dir/hello world: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf1808f4_d20220113_m050917_c001_v0001033_t0036") 2022/01/13 05:19:00 DEBUG : sub dir/hello world: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f110e5d7c01b6798d_d20220113_m050916_c001_v0001015_t0010") 2022/01/13 05:19:00 DEBUG : sub dir/hello world: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf1808ed_d20220113_m050915_c001_v0001033_t0026") 2022/01/13 05:19:00 DEBUG : sub dir/hello world: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1144e6788a700831_d20220113_m050914_c001_v0001161_t0028") 2022/01/13 05:19:00 DEBUG : sub dir/hello world: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf1808ce_d20220113_m050910_c001_v0001033_t0040") 2022/01/13 05:19:01 DEBUG : sub dir/hello world: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f11860e867a93f328_d20220113_m050909_c001_v0001098_t0020") 2022/01/13 05:19:01 DEBUG : sub dir/hello world: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf1808c2_d20220113_m050908_c001_v0001033_t0054") 2022/01/13 05:19:01 DEBUG : sub dir/hello world: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f11525f0bb06b9839_d20220113_m050907_c001_v0001146_t0002") 2022/01/13 05:19:01 DEBUG : sub dir/hello world: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf1808bb_d20220113_m050906_c001_v0001033_t0055") 2022/01/13 05:19:01 DEBUG : sub dir/hello world: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f102655c71bf22230_d20220113_m050905_c001_v0001093_t0006") 2022/01/13 05:19:01 DEBUG : sub dir/hello world: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf1808af_d20220113_m050904_c001_v0001033_t0010") 2022/01/13 05:19:01 DEBUG : sub dir/hello world: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f119ce1a3eaa6b004_d20220113_m050857_c001_v0001105_t0015") 2022/01/13 05:19:01 DEBUG : sub dir/hello world: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180876_d20220113_m050856_c001_v0001033_t0017") 2022/01/13 05:19:01 DEBUG : sub dir/hello world: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f102e8c11ad84a2dd_d20220113_m050853_c001_v0001144_t0037") 2022/01/13 05:19:01 DEBUG : sub dir/hello world: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf18086b_d20220113_m050852_c001_v0001033_t0039") 2022/01/13 05:19:01 DEBUG : sub dir/hello world: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f102332ac422a2c53_d20220113_m050851_c001_v0001036_t0011") 2022/01/13 05:19:01 DEBUG : sub dir/hello world: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180861_d20220113_m050850_c001_v0001033_t0044") 2022/01/13 05:19:01 DEBUG : sub dir/hello world: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f118a3c373b10df77_d20220113_m050848_c001_v0001157_t0044") 2022/01/13 05:19:01 DEBUG : sub dir/hello world: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf18084f_d20220113_m050847_c001_v0001033_t0009") 2022/01/13 05:19:01 DEBUG : sub/yam: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1115f2f71a714ce4_d20220113_m051120_c001_v0001105_t0046") 2022/01/13 05:19:01 DEBUG : sub/yam: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a00636_d20220113_m051117_c001_v0001131_t0048") 2022/01/13 05:19:01 DEBUG : three: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1182dbcf56ae8053_d20220113_m051104_c001_v0001041_t0021") 2022/01/13 05:19:02 DEBUG : three: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a00589_d20220113_m051059_c001_v0001131_t0025") 2022/01/13 05:19:02 DEBUG : three: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180aa8_d20220113_m051053_c001_v0001033_t0022") 2022/01/13 05:19:02 DEBUG : two: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1133baf70647f9a4_d20220113_m051104_c001_v0001157_t0011") 2022/01/13 05:19:02 DEBUG : two: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a00572_d20220113_m051058_c001_v0001131_t0023") 2022/01/13 05:19:02 DEBUG : two: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1042848dbf180aa4_d20220113_m051053_c001_v0001033_t0028") 2022/01/13 05:19:02 DEBUG : yam: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f110790b82c8d28fa_d20220113_m051122_c001_v0001042_t0031") 2022/01/13 05:19:02 DEBUG : yam: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f107150c010c8f677_d20220113_m051119_c001_v0001097_t0023") 2022/01/13 05:19:02 DEBUG : yam: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1006bddbdcaf0ca9_d20220113_m051115_c001_v0001042_t0003") 2022/01/13 05:19:02 DEBUG : yam: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f111024e668a005f3_d20220113_m051112_c001_v0001131_t0000") 2022/01/13 05:19:02 DEBUG : yam: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f102bd20ccbcb6c41_d20220113_m051108_c001_v0001130_t0020") 2022/01/13 05:19:02 DEBUG : yam: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1129b03e7ac670ac_d20220113_m051105_c001_v0001105_t0057") 2022/01/13 05:19:02 DEBUG : yaml: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f109ae94d156f2ab6_d20220113_m051116_c001_v0001105_t0029") 2022/01/13 05:19:02 DEBUG : yaml: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f1118b86fb9759762_d20220113_m051113_c001_v0001120_t0036") 2022/01/13 05:19:02 DEBUG : yaml: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f11948d8c5339f2ed_d20220113_m051110_c001_v0001137_t0056") 2022/01/13 05:19:02 DEBUG : yaml: Deleting (id "4_z1f229da3d06d5b1b7fe80e1b_f116ea032280bf686_d20220113_m051107_c001_v0001117_t0049") "./sync.test -test.v -test.timeout 1h0m0s -remote TestB2: -list-retries 5 -verbose" - Finished OK in 10m19.398169368s (try 1/5)