"./bisync.test -test.v -test.timeout 2h0m0s -remote TestPutio: -verbose -test.run '^TestBisyncLocalRemote$/^(backupdir|changes|max_delete_path2_force)$|^TestBisyncRemoteLocal$/^(nomodtime|resync)$|^TestBisyncRemoteRemote$/^(check_access_filters|concurrent|filters|nomodtime|normalization)$'" - Starting (try 4/5)
=== RUN   TestBisyncRemoteLocal
2025/06/04 01:55:42 NOTICE: remote: TestPutio:rclone-test-wukaboq6giwo
=== RUN   TestBisyncRemoteLocal/nomodtime
2025/06/04 01:55:43 ERROR : error listing: directory not found
2025/06/04 01:55:43 ERROR : error listing: directory not found
2025/06/04 01:55:43 NOTICE: checking initFs Local file system at /tmp/015542bi/initdir/test_nomodtime-bimizar7
2025/06/04 01:55:45 NOTICE: checking Path1 Putio root 'rclone-test-wukaboq6giwo/015542bi/nomodtime/path1'
2025/06/04 01:55:45 NOTICE: checking path2 Local file system at /tmp/015542bi/nomodtime/path2
2025/06/04 01:55:45 NOTICE: (01)  : test changes
2025/06/04 01:55:45 NOTICE: (02)  : test initial bisync
2025/06/04 01:55:45 NOTICE: (03)  : bisync resync nomodtime
2025/06/04 01:55:46 INFO  : Bisyncing with Comparison Settings: 
{
	"Modtime": false,
	"Size": true,
	"Checksum": true,
	"HashType1": 8,
	"HashType2": 8,
	"NoSlowHash": false,
	"SlowHashSyncOnly": false,
	"SlowHashDetected": true,
	"DownloadHash": true
}
2025/06/04 01:55:46 INFO  : Synching Path1 "TestPutio:rclone-test-wukaboq6giwo/015542bi/nomodtime/path1/" with Path2 "/tmp/015542bi/nomodtime/path2/"
2025/06/04 01:55:46 INFO  : Copying Path2 files to Path1
2025/06/04 01:55:46 INFO  : - Path2    Resync is copying files to         - Path1
2025/06/04 01:55:46 INFO  : - Path1    Resync is copying files to         - Path2
2025/06/04 01:55:46 INFO  : Resync updating listings
2025/06/04 01:55:46 INFO  : Validating listings for Path1 "TestPutio:rclone-test-wukaboq6giwo/015542bi/nomodtime/path1/" vs Path2 "/tmp/015542bi/nomodtime/path2/"
2025/06/04 01:55:46 INFO  : Bisync successful
2025/06/04 01:55:46 NOTICE: (04)  : test make modifications on both paths
2025/06/04 01:55:46 NOTICE: (05)  : test new on path2 - file10
2025/06/04 01:55:46 NOTICE: (06)  : copy-file /tmp/015542bi/datadir/test_nomodtime-bufakac7/file10.txt /tmp/015542bi/nomodtime/path2/
2025/06/04 01:55:46 NOTICE: (07)  : test changed on path2 - file1
2025/06/04 01:55:46 NOTICE: (08)  : copy-file /tmp/015542bi/datadir/test_nomodtime-bufakac7/file1.txt /tmp/015542bi/nomodtime/path2/
2025/06/04 01:55:46 NOTICE: (09)  : test new on path1 - file11
2025/06/04 01:55:46 NOTICE: (10)  : copy-file /tmp/015542bi/datadir/test_nomodtime-bufakac7/file11.txt TestPutio:rclone-test-wukaboq6giwo/015542bi/nomodtime/path1/
2025/06/04 01:55:47 NOTICE: (11)  : test changed on path1 - file2
2025/06/04 01:55:47 NOTICE: (12)  : copy-file /tmp/015542bi/datadir/test_nomodtime-bufakac7/file2.txt TestPutio:rclone-test-wukaboq6giwo/015542bi/nomodtime/path1/
2025/06/04 01:55:49 NOTICE: (13)  : test deleted on path2 - file3
2025/06/04 01:55:49 NOTICE: (14)  : delete-file /tmp/015542bi/nomodtime/path2/file3.txt
2025/06/04 01:55:49 NOTICE: (15)  : test deleted on path1 - file4
2025/06/04 01:55:49 NOTICE: (16)  : delete-file TestPutio:rclone-test-wukaboq6giwo/015542bi/nomodtime/path1/file4.txt
2025/06/04 01:55:49 NOTICE: (17)  : test deleted on both paths - file8
2025/06/04 01:55:49 NOTICE: (18)  : delete-file TestPutio:rclone-test-wukaboq6giwo/015542bi/nomodtime/path1/file8.txt
2025/06/04 01:55:49 NOTICE: (19)  : delete-file /tmp/015542bi/nomodtime/path2/file8.txt
2025/06/04 01:55:49 NOTICE: (20)  : test changed on both paths - file5 (file5R, file5L)
2025/06/04 01:55:49 NOTICE: (21)  : copy-as /tmp/015542bi/datadir/test_nomodtime-bufakac7/file5R.txt /tmp/015542bi/nomodtime/path2/ file5.txt
2025/06/04 01:55:49 NOTICE: (22)  : copy-as /tmp/015542bi/datadir/test_nomodtime-bufakac7/file5L.txt TestPutio:rclone-test-wukaboq6giwo/015542bi/nomodtime/path1/ file5.txt
2025/06/04 01:55:50 NOTICE: (23)  : test changed on path2 and deleted on path1 - file6
2025/06/04 01:55:50 NOTICE: (24)  : copy-file /tmp/015542bi/datadir/test_nomodtime-bufakac7/file6.txt /tmp/015542bi/nomodtime/path2/
2025/06/04 01:55:50 NOTICE: (25)  : delete-file TestPutio:rclone-test-wukaboq6giwo/015542bi/nomodtime/path1/file6.txt
2025/06/04 01:55:51 NOTICE: (26)  : test changed on path1 and deleted on path2 - file7
2025/06/04 01:55:51 NOTICE: (27)  : copy-file /tmp/015542bi/datadir/test_nomodtime-bufakac7/file7.txt TestPutio:rclone-test-wukaboq6giwo/015542bi/nomodtime/path1/
2025/06/04 01:55:52 NOTICE: (28)  : delete-file /tmp/015542bi/nomodtime/path2/file7.txt
2025/06/04 01:55:52 NOTICE: (29)  : test bisync run
2025/06/04 01:55:52 NOTICE: (30)  : bisync nomodtime
2025/06/04 01:55:53 INFO  : Bisyncing with Comparison Settings: 
{
	"Modtime": false,
	"Size": true,
	"Checksum": true,
	"HashType1": 8,
	"HashType2": 8,
	"NoSlowHash": false,
	"SlowHashSyncOnly": false,
	"SlowHashDetected": true,
	"DownloadHash": true
}
2025/06/04 01:55:53 INFO  : Synching Path1 "TestPutio:rclone-test-wukaboq6giwo/015542bi/nomodtime/path1/" with Path2 "/tmp/015542bi/nomodtime/path2/"
2025/06/04 01:55:53 INFO  : Building Path1 and Path2 listings
2025/06/04 01:55:53 INFO  : Path1 checking for diffs
2025/06/04 01:55:53 INFO  : - Path1    File changed: size (larger), hash - file2.txt
2025/06/04 01:55:53 INFO  : - Path1    File was deleted          - file4.txt
2025/06/04 01:55:53 INFO  : - Path1    File changed: size (larger), hash - file5.txt
2025/06/04 01:55:53 INFO  : - Path1    File was deleted          - file6.txt
2025/06/04 01:55:53 INFO  : - Path1    File changed: size (larger), hash - file7.txt
2025/06/04 01:55:53 INFO  : - Path1    File was deleted          - file8.txt
2025/06/04 01:55:53 INFO  : - Path1    File is new               - file11.txt
2025/06/04 01:55:53 INFO  : Path1:    7 changes:    1 new,    3 modified,    3 deleted
2025/06/04 01:55:53 INFO  : (Modified:    3 larger,    0 smaller,    3 hash differs)
2025/06/04 01:55:53 INFO  : Path2 checking for diffs
2025/06/04 01:55:53 INFO  : - Path2    File changed: size (larger), hash - file1.txt
2025/06/04 01:55:53 INFO  : - Path2    File was deleted          - file3.txt
2025/06/04 01:55:53 INFO  : - Path2    File changed: size (larger), hash - file5.txt
2025/06/04 01:55:53 INFO  : - Path2    File changed: size (larger), hash - file6.txt
2025/06/04 01:55:53 INFO  : - Path2    File was deleted          - file7.txt
2025/06/04 01:55:53 INFO  : - Path2    File was deleted          - file8.txt
2025/06/04 01:55:53 INFO  : - Path2    File is new               - file10.txt
2025/06/04 01:55:53 INFO  : Path2:    7 changes:    1 new,    3 modified,    3 deleted
2025/06/04 01:55:53 INFO  : (Modified:    3 larger,    0 smaller,    3 hash differs)
2025/06/04 01:55:53 INFO  : Applying changes
2025/06/04 01:55:53 INFO  : - Path1    Queue copy to Path2       - /tmp/015542bi/nomodtime/path2/file11.txt
2025/06/04 01:55:53 INFO  : - Path1    Queue copy to Path2       - /tmp/015542bi/nomodtime/path2/file2.txt
2025/06/04 01:55:53 INFO  : - Path2    Queue delete              - /tmp/015542bi/nomodtime/path2/file4.txt
2025/06/04 01:55:53 NOTICE: - WARNING  New or changed in both paths       - file5.txt
2025/06/04 01:55:53 NOTICE: - Path1    Renaming Path1 copy                - TestPutio:rclone-test-wukaboq6giwo/015542bi/nomodtime/path1/file5.txt.conflict1
2025/06/04 01:55:53 INFO  : file5.txt: Moved (server-side) to: file5.txt.conflict1
2025/06/04 01:55:53 NOTICE: - Path1    Queue copy to Path2       - /tmp/015542bi/nomodtime/path2/file5.txt.conflict1
2025/06/04 01:55:53 NOTICE: - Path2    Renaming Path2 copy                - /tmp/015542bi/nomodtime/path2/file5.txt.conflict2
2025/06/04 01:55:53 INFO  : file5.txt: Moved (server-side) to: file5.txt.conflict2
2025/06/04 01:55:53 NOTICE: - Path2    Queue copy to Path1       - TestPutio:rclone-test-wukaboq6giwo/015542bi/nomodtime/path1/file5.txt.conflict2
2025/06/04 01:55:53 INFO  : - Path2    Queue copy to Path1       - TestPutio:rclone-test-wukaboq6giwo/015542bi/nomodtime/path1/file6.txt
2025/06/04 01:55:53 INFO  : - Path1    Queue copy to Path2       - /tmp/015542bi/nomodtime/path2/file7.txt
2025/06/04 01:55:53 INFO  : - Path2    Queue copy to Path1       - TestPutio:rclone-test-wukaboq6giwo/015542bi/nomodtime/path1/file1.txt
2025/06/04 01:55:53 INFO  : - Path2    Queue copy to Path1       - TestPutio:rclone-test-wukaboq6giwo/015542bi/nomodtime/path1/file10.txt
2025/06/04 01:55:53 INFO  : - Path1    Queue delete              - TestPutio:rclone-test-wukaboq6giwo/015542bi/nomodtime/path1/file3.txt
2025/06/04 01:55:53 INFO  : - Path2    Do queued copies to                - Path1
2025/06/04 01:55:54 INFO  : file10.txt: Copied (new)
2025/06/04 01:55:54 INFO  : file6.txt: Copied (new)
2025/06/04 01:55:54 INFO  : file5.txt.conflict2: Copied (new)
2025/06/04 01:55:55 INFO  : file1.txt: Copied (replaced existing)
2025/06/04 01:55:55 INFO  : file3.txt: Deleted
2025/06/04 01:55:55 INFO  : - Path1    Do queued copies to                - Path2
2025/06/04 01:55:56 INFO  : file11.txt: Copied (new)
2025/06/04 01:55:56 INFO  : file2.txt: Copied (replaced existing)
2025/06/04 01:55:56 INFO  : file7.txt: Copied (new)
2025/06/04 01:55:56 INFO  : file5.txt.conflict1: Copied (new)
2025/06/04 01:55:56 INFO  : file4.txt: Deleted
2025/06/04 01:55:56 INFO  : Updating listings
2025/06/04 01:55:56 INFO  : Validating listings for Path1 "TestPutio:rclone-test-wukaboq6giwo/015542bi/nomodtime/path1/" vs Path2 "/tmp/015542bi/nomodtime/path2/"
2025/06/04 01:55:56 INFO  : Bisync successful
    bisync_test.go:560: TEST nomodtime PASSED
=== RUN   TestBisyncRemoteLocal/resync
2025/06/04 01:55:56 ERROR : error listing: directory not found
2025/06/04 01:55:56 ERROR : error listing: directory not found
2025/06/04 01:55:56 NOTICE: checking initFs Local file system at /tmp/015542bi/initdir/test_resync-namasuj1
2025/06/04 01:55:58 ERROR : file6.txt: Failed to copy: unexpected status code (404) response while doing PATCH to https://s111.put.io/files/540aafbae245c6c8bd4a4e6d20ba6cd241967aab
    bisync_test.go:1943: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:1943
        	            				/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:458
        	            				/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:358
        	Error:      	Received unexpected error:
        	            	unexpected status code (404) response while doing PATCH to https://s111.put.io/files/540aafbae245c6c8bd4a4e6d20ba6cd241967aab
        	Test:       	TestBisyncRemoteLocal/resync
        	Messages:   	setting up path1
2025/06/04 01:55:58 NOTICE: checking Path1 Putio root 'rclone-test-wukaboq6giwo/015542bi/resync/path1'
    fstest.go:292: Sleeping for 1s for list eventual consistency: 1/3
    fstest.go:295: Flushing the directory cache
    fstest.go:292: Sleeping for 2s for list eventual consistency: 2/3
    fstest.go:295: Flushing the directory cache
    fstest.go:292: Sleeping for 4s for list eventual consistency: 3/3
    fstest.go:295: Flushing the directory cache
    fstest.go:299: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:299
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:332
        	            				/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:460
        	            				/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:358
        	Error:      	Should be true
        	Test:       	TestBisyncRemoteLocal/resync
        	Messages:   	listing wrong, want
        	            	  RCLONE_TEST (109), file1.txt (0), file2.txt (0), file3.txt (0), file4.txt (0), file5.txt (0), file6.txt (0), file7.txt (0) got
        	            	  RCLONE_TEST (109), file1.txt (0), file2.txt (0), file3.txt (0), file4.txt (0), file5.txt (0), file7.txt (0)
    fstest.go:197: Not found "file6.txt"
    fstest.go:200: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:200
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:304
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:332
        	            				/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:460
        	            				/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:358
        	Error:      	Not equal: 
        	            	expected: 0
        	            	actual  : 1
        	Test:       	TestBisyncRemoteLocal/resync
        	Messages:   	1 objects not found
2025/06/04 01:56:06 NOTICE: checking path2 Local file system at /tmp/015542bi/resync/path2
2025/06/04 01:56:06 NOTICE: (01)  : test resync
2025/06/04 01:56:06 NOTICE: (02)  : test 1. resync with empty path1, resulting in copying all content from path2.
2025/06/04 01:56:06 NOTICE: (03)  : purge-children TestPutio:rclone-test-wukaboq6giwo/015542bi/resync/path1/
2025/06/04 01:56:07 NOTICE: (04)  : bisync resync
2025/06/04 01:56:08 INFO  : Setting --ignore-listing-checksum as neither --checksum nor --compare checksum are set.
2025/06/04 01:56:08 INFO  : Bisyncing with Comparison Settings: 
{
	"Modtime": true,
	"Size": true,
	"Checksum": false,
	"HashType1": 0,
	"HashType2": 0,
	"NoSlowHash": false,
	"SlowHashSyncOnly": false,
	"SlowHashDetected": true,
	"DownloadHash": false
}
2025/06/04 01:56:08 INFO  : Synching Path1 "TestPutio:rclone-test-wukaboq6giwo/015542bi/resync/path1/" with Path2 "/tmp/015542bi/resync/path2/"
2025/06/04 01:56:08 INFO  : Copying Path2 files to Path1
2025/06/04 01:56:08 INFO  : - Path2    Resync is copying files to         - Path1
2025/06/04 01:56:08 INFO  : file2.txt: Copied (new)
2025/06/04 01:56:09 INFO  : file3.txt: Copied (new)
2025/06/04 01:56:09 INFO  : RCLONE_TEST: Copied (new)
2025/06/04 01:56:09 INFO  : file1.txt: Copied (new)
2025/06/04 01:56:09 ERROR : file4.txt: Failed to copy: unexpected status code (404) response while doing PATCH to https://s106.put.io/files/aba3695d74db84bc74de2f8a09770f92965d59d7
2025/06/04 01:56:09 INFO  : file5.txt: Copied (new)
2025/06/04 01:56:09 INFO  : file6.txt: Copied (new)
2025/06/04 01:56:10 INFO  : file7.txt: Copied (new)
2025/06/04 01:56:10 ERROR : Bisync critical error: unexpected status code (404) response while doing PATCH to https://s106.put.io/files/aba3695d74db84bc74de2f8a09770f92965d59d7
2025/06/04 01:56:10 ERROR : Bisync aborted. Must run --resync to recover.
2025/06/04 01:56:10 NOTICE: Bisync error: bisync aborted
2025/06/04 01:56:10 NOTICE: (05)  : move-listings empty-path1
2025/06/04 01:56:10 NOTICE: (06)  : test 2. resync with empty path2, resulting in syncing all content to path2.
2025/06/04 01:56:10 NOTICE: (07)  : purge-children /tmp/015542bi/resync/path2/
2025/06/04 01:56:10 NOTICE: (08)  : bisync resync
2025/06/04 01:56:10 INFO  : Setting --ignore-listing-checksum as neither --checksum nor --compare checksum are set.
2025/06/04 01:56:10 INFO  : Bisyncing with Comparison Settings: 
{
	"Modtime": true,
	"Size": true,
	"Checksum": false,
	"HashType1": 0,
	"HashType2": 0,
	"NoSlowHash": false,
	"SlowHashSyncOnly": false,
	"SlowHashDetected": true,
	"DownloadHash": false
}
2025/06/04 01:56:10 INFO  : Synching Path1 "TestPutio:rclone-test-wukaboq6giwo/015542bi/resync/path1/" with Path2 "/tmp/015542bi/resync/path2/"
2025/06/04 01:56:10 INFO  : Copying Path2 files to Path1
2025/06/04 01:56:10 INFO  : - Path2    Resync is copying files to         - Path1
2025/06/04 01:56:10 INFO  : - Path1    Resync is copying files to         - Path2
2025/06/04 01:56:11 INFO  : file1.txt: Copied (new)
2025/06/04 01:56:11 INFO  : file3.txt: Copied (new)
2025/06/04 01:56:11 INFO  : RCLONE_TEST: Copied (new)
2025/06/04 01:56:11 INFO  : file2.txt: Copied (new)
2025/06/04 01:56:11 INFO  : file5.txt: Copied (new)
2025/06/04 01:56:11 INFO  : file6.txt: Copied (new)
2025/06/04 01:56:11 INFO  : file7.txt: Copied (new)
2025/06/04 01:56:11 INFO  : Resync updating listings
2025/06/04 01:56:11 INFO  : Validating listings for Path1 "TestPutio:rclone-test-wukaboq6giwo/015542bi/resync/path1/" vs Path2 "/tmp/015542bi/resync/path2/"
2025/06/04 01:56:11 INFO  : Bisync successful
2025/06/04 01:56:11 NOTICE: (09)  : move-listings empty-path2
2025/06/04 01:56:11 NOTICE: (10)  : test 3. exercise all of the various file difference scenarios during a resync.
2025/06/04 01:56:11 NOTICE: (11)  : touch-glob 2002-02-02 /tmp/015542bi/datadir/test_resync-dequpul0/ fileA.txt
2025/06/04 01:56:11 NOTICE: (12)  : touch-glob 1999-09-09 /tmp/015542bi/datadir/test_resync-dequpul0/ fileB.txt
2025/06/04 01:56:11 NOTICE: (13)  : test = file      - path1      - path2      - expected action    - who wins
2025/06/04 01:56:11 NOTICE: (14)  : test - file1.txt - exists     - missing    - sync path1 > path2 - path1
2025/06/04 01:56:11 NOTICE: (15)  : delete-file /tmp/015542bi/resync/path2/file1.txt
2025/06/04 01:56:11 NOTICE: (16)  : test - file2.txt - missing    - exists     - copy path2 > path1 - path2
2025/06/04 01:56:11 NOTICE: (17)  : delete-file TestPutio:rclone-test-wukaboq6giwo/015542bi/resync/path1/file2.txt
2025/06/04 01:56:12 NOTICE: (18)  : test - file3.txt - exists     - newer date - sync path1 > path2 - path1
2025/06/04 01:56:12 NOTICE: (19)  : copy-as /tmp/015542bi/datadir/test_resync-dequpul0/fileA.txt /tmp/015542bi/resync/path2/ file3.txt
2025/06/04 01:56:12 NOTICE: (20)  : test - file4.txt - missing    - newer date - copy path2 > path1 - path2
2025/06/04 01:56:12 NOTICE: (21)  : delete-file TestPutio:rclone-test-wukaboq6giwo/015542bi/resync/path1/file4.txt
    bisync_test.go:495: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:495
        	            				/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:358
        	Error:      	test step failed
        	Test:       	TestBisyncRemoteLocal/resync
        	Messages:   	step 21 failed: object not found
--- FAIL: TestBisyncRemoteLocal (30.62s)
    --- PASS: TestBisyncRemoteLocal/nomodtime (14.06s)
    --- FAIL: TestBisyncRemoteLocal/resync (16.15s)
=== RUN   TestBisyncLocalRemote
2025/06/04 01:56:12 NOTICE: remote: TestPutio:rclone-test-husosaw9buto
=== RUN   TestBisyncLocalRemote/backupdir
2025/06/04 01:56:13 ERROR : error listing: directory not found
2025/06/04 01:56:13 ERROR : error listing: directory not found
2025/06/04 01:56:13 NOTICE: checking initFs Local file system at /tmp/015612vi/initdir/test_backupdir-zukuzup7
2025/06/04 01:56:13 NOTICE: checking Path1 Local file system at /tmp/015612vi/backupdir/path1
2025/06/04 01:56:17 NOTICE: checking path2 Putio root 'rclone-test-husosaw9buto/015612vi/backupdir/path2'
2025/06/04 01:56:17 NOTICE: (01)  : test backupdir
2025/06/04 01:56:17 NOTICE: (02)  : test initial bisync
2025/06/04 01:56:17 NOTICE: (03)  : bisync resync backupdir1=/tmp/015612vi/workdir/backupdirs/backupdir1 backupdir2=/tmp/015612vi/workdir/backupdirs/backupdir2
    bisync_test.go:934: backupdir test currently only works on local (it uses the workdir)
=== RUN   TestBisyncLocalRemote/changes
2025/06/04 01:56:17 ERROR : error listing: directory not found
2025/06/04 01:56:17 ERROR : error listing: directory not found
2025/06/04 01:56:17 NOTICE: checking initFs Local file system at /tmp/015612vi/initdir/test_changes-julecum0
2025/06/04 01:56:17 NOTICE: checking Path1 Local file system at /tmp/015612vi/changes/path1
2025/06/04 01:56:19 ERROR : file5.txt: Failed to copy: unexpected status code (404) response while doing PATCH to https://s84.put.io/files/3a6e96abc5684c6f3a61ceb7bfd38ea23dc979c8
    bisync_test.go:1943: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:1943
        	            				/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:461
        	            				/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:358
        	Error:      	Received unexpected error:
        	            	unexpected status code (404) response while doing PATCH to https://s84.put.io/files/3a6e96abc5684c6f3a61ceb7bfd38ea23dc979c8
        	Test:       	TestBisyncLocalRemote/changes
        	Messages:   	setting up path2
2025/06/04 01:56:20 NOTICE: checking path2 Putio root 'rclone-test-husosaw9buto/015612vi/changes/path2'
    fstest.go:292: Sleeping for 1s for list eventual consistency: 1/3
    fstest.go:295: Flushing the directory cache
    fstest.go:292: Sleeping for 2s for list eventual consistency: 2/3
    fstest.go:295: Flushing the directory cache
    fstest.go:292: Sleeping for 4s for list eventual consistency: 3/3
    fstest.go:295: Flushing the directory cache
    fstest.go:299: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:299
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:332
        	            				/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:463
        	            				/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:358
        	Error:      	Should be true
        	Test:       	TestBisyncLocalRemote/changes
        	Messages:   	listing wrong, want
        	            	  RCLONE_TEST (109), file1.txt (0), file2.txt (0), file3.txt (0), file4.txt (0), file5.txt (0), file6.txt (0), file7.txt (0), file8.txt (0) got
        	            	  RCLONE_TEST (109), file1.txt (0), file2.txt (0), file3.txt (0), file4.txt (0), file6.txt (0), file7.txt (0), file8.txt (0)
    fstest.go:197: Not found "file5.txt"
    fstest.go:200: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:200
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:304
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:332
        	            				/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:463
        	            				/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:358
        	Error:      	Not equal: 
        	            	expected: 0
        	            	actual  : 1
        	Test:       	TestBisyncLocalRemote/changes
        	Messages:   	1 objects not found
2025/06/04 01:56:28 NOTICE: (01)  : test changes
2025/06/04 01:56:28 NOTICE: (02)  : test initial bisync
2025/06/04 01:56:28 NOTICE: (03)  : bisync resync
2025/06/04 01:56:29 INFO  : Setting --ignore-listing-checksum as neither --checksum nor --compare checksum are set.
2025/06/04 01:56:29 INFO  : Bisyncing with Comparison Settings: 
{
	"Modtime": true,
	"Size": true,
	"Checksum": false,
	"HashType1": 0,
	"HashType2": 0,
	"NoSlowHash": false,
	"SlowHashSyncOnly": false,
	"SlowHashDetected": true,
	"DownloadHash": false
}
2025/06/04 01:56:29 INFO  : Synching Path1 "/tmp/015612vi/changes/path1/" with Path2 "TestPutio:rclone-test-husosaw9buto/015612vi/changes/path2/"
2025/06/04 01:56:29 INFO  : Copying Path2 files to Path1
2025/06/04 01:56:29 INFO  : - Path2    Resync is copying files to         - Path1
2025/06/04 01:56:29 INFO  : - Path1    Resync is copying files to         - Path2
2025/06/04 01:56:30 INFO  : file5.txt: Copied (new)
2025/06/04 01:56:30 INFO  : Resync updating listings
2025/06/04 01:56:30 INFO  : Validating listings for Path1 "/tmp/015612vi/changes/path1/" vs Path2 "TestPutio:rclone-test-husosaw9buto/015612vi/changes/path2/"
2025/06/04 01:56:30 INFO  : Bisync successful
2025/06/04 01:56:30 NOTICE: (04)  : test make modifications on both paths
2025/06/04 01:56:30 NOTICE: (05)  : test new on path2 - file10
2025/06/04 01:56:30 NOTICE: (06)  : touch-copy 2001-01-02 /tmp/015612vi/datadir/test_changes-sixoqeg6/file10.txt TestPutio:rclone-test-husosaw9buto/015612vi/changes/path2/
2025/06/04 01:56:31 NOTICE: (07)  : test newer on path2 - file1
2025/06/04 01:56:31 NOTICE: (08)  : touch-copy 2001-01-02 /tmp/015612vi/datadir/test_changes-sixoqeg6/file1.txt TestPutio:rclone-test-husosaw9buto/015612vi/changes/path2/
2025/06/04 01:56:32 NOTICE: (09)  : test new on path1 - file11
2025/06/04 01:56:32 NOTICE: (10)  : touch-copy 2001-01-02 /tmp/015612vi/datadir/test_changes-sixoqeg6/file11.txt /tmp/015612vi/changes/path1/
2025/06/04 01:56:32 NOTICE: (11)  : test newer on path1 - file2
2025/06/04 01:56:32 NOTICE: (12)  : touch-copy 2001-01-02 /tmp/015612vi/datadir/test_changes-sixoqeg6/file2.txt /tmp/015612vi/changes/path1/
2025/06/04 01:56:32 NOTICE: (13)  : test deleted on path2 - file3
2025/06/04 01:56:32 NOTICE: (14)  : delete-file TestPutio:rclone-test-husosaw9buto/015612vi/changes/path2/file3.txt
2025/06/04 01:56:32 NOTICE: (15)  : test deleted on path1 - file4
2025/06/04 01:56:32 NOTICE: (16)  : delete-file /tmp/015612vi/changes/path1/file4.txt
2025/06/04 01:56:32 NOTICE: (17)  : test deleted on both paths - file8
2025/06/04 01:56:32 NOTICE: (18)  : delete-file /tmp/015612vi/changes/path1/file8.txt
2025/06/04 01:56:32 NOTICE: (19)  : delete-file TestPutio:rclone-test-husosaw9buto/015612vi/changes/path2/file8.txt
2025/06/04 01:56:33 NOTICE: (20)  : test changed on both paths - file5 (file5R, file5L)
2025/06/04 01:56:33 NOTICE: (21)  : touch-glob 2001-01-02 /tmp/015612vi/datadir/test_changes-sixoqeg6/ file5R.txt
2025/06/04 01:56:33 NOTICE: (22)  : copy-as /tmp/015612vi/datadir/test_changes-sixoqeg6/file5R.txt TestPutio:rclone-test-husosaw9buto/015612vi/changes/path2/ file5.txt
2025/06/04 01:56:34 NOTICE: (23)  : touch-glob 2001-03-04 /tmp/015612vi/datadir/test_changes-sixoqeg6/ file5L.txt
2025/06/04 01:56:34 NOTICE: (24)  : copy-as /tmp/015612vi/datadir/test_changes-sixoqeg6/file5L.txt /tmp/015612vi/changes/path1/ file5.txt
2025/06/04 01:56:34 NOTICE: (25)  : test newer on path2 and deleted on path1 - file6
2025/06/04 01:56:34 NOTICE: (26)  : touch-copy 2001-01-02 /tmp/015612vi/datadir/test_changes-sixoqeg6/file6.txt TestPutio:rclone-test-husosaw9buto/015612vi/changes/path2/
2025/06/04 01:56:35 NOTICE: (27)  : delete-file /tmp/015612vi/changes/path1/file6.txt
2025/06/04 01:56:35 NOTICE: (28)  : test newer on path1 and deleted on path2 - file7
2025/06/04 01:56:35 NOTICE: (29)  : touch-copy 2001-01-02 /tmp/015612vi/datadir/test_changes-sixoqeg6/file7.txt /tmp/015612vi/changes/path1/
2025/06/04 01:56:35 NOTICE: (30)  : delete-file TestPutio:rclone-test-husosaw9buto/015612vi/changes/path2/file7.txt
2025/06/04 01:56:35 NOTICE: (31)  : test bisync run
2025/06/04 01:56:35 NOTICE: (32)  : bisync
2025/06/04 01:56:36 INFO  : Setting --ignore-listing-checksum as neither --checksum nor --compare checksum are set.
2025/06/04 01:56:36 INFO  : Bisyncing with Comparison Settings: 
{
	"Modtime": true,
	"Size": true,
	"Checksum": false,
	"HashType1": 0,
	"HashType2": 0,
	"NoSlowHash": false,
	"SlowHashSyncOnly": false,
	"SlowHashDetected": true,
	"DownloadHash": false
}
2025/06/04 01:56:36 INFO  : Synching Path1 "/tmp/015612vi/changes/path1/" with Path2 "TestPutio:rclone-test-husosaw9buto/015612vi/changes/path2/"
2025/06/04 01:56:36 INFO  : Building Path1 and Path2 listings
2025/06/04 01:56:36 INFO  : Path1 checking for diffs
2025/06/04 01:56:36 INFO  : - Path1    File changed: size (larger), time (newer) - file2.txt
2025/06/04 01:56:36 INFO  : - Path1    File was deleted          - file4.txt
2025/06/04 01:56:36 INFO  : - Path1    File changed: size (larger), time (newer) - file5.txt
2025/06/04 01:56:36 INFO  : - Path1    File was deleted          - file6.txt
2025/06/04 01:56:36 INFO  : - Path1    File changed: size (larger), time (newer) - file7.txt
2025/06/04 01:56:36 INFO  : - Path1    File was deleted          - file8.txt
2025/06/04 01:56:36 INFO  : - Path1    File is new               - file11.txt
2025/06/04 01:56:36 INFO  : Path1:    7 changes:    1 new,    3 modified,    3 deleted
2025/06/04 01:56:36 INFO  : (Modified:    3 newer,    0 older,    3 larger,    0 smaller)
2025/06/04 01:56:36 INFO  : Path2 checking for diffs
2025/06/04 01:56:36 INFO  : - Path2    File changed: size (larger), time (newer) - file1.txt
2025/06/04 01:56:36 INFO  : - Path2    File was deleted          - file3.txt
2025/06/04 01:56:36 INFO  : - Path2    File changed: size (larger), time (newer) - file5.txt
2025/06/04 01:56:36 INFO  : - Path2    File changed: size (larger), time (newer) - file6.txt
2025/06/04 01:56:36 INFO  : - Path2    File was deleted          - file7.txt
2025/06/04 01:56:36 INFO  : - Path2    File was deleted          - file8.txt
2025/06/04 01:56:36 INFO  : - Path2    File is new               - file10.txt
2025/06/04 01:56:36 INFO  : Path2:    7 changes:    1 new,    3 modified,    3 deleted
2025/06/04 01:56:36 INFO  : (Modified:    3 newer,    0 older,    3 larger,    0 smaller)
2025/06/04 01:56:36 INFO  : Applying changes
2025/06/04 01:56:36 INFO  : Checking potential conflicts...
2025/06/04 01:56:36 ERROR : file5.txt: crc32 differ
2025/06/04 01:56:36 NOTICE: Putio root 'rclone-test-husosaw9buto/015612vi/changes/path2': 1 differences found
2025/06/04 01:56:36 NOTICE: Putio root 'rclone-test-husosaw9buto/015612vi/changes/path2': 1 errors while checking
2025/06/04 01:56:36 INFO  : Finished checking the potential conflicts. 1 differences found
2025/06/04 01:56:36 INFO  : - Path1    Queue copy to Path2       - TestPutio:rclone-test-husosaw9buto/015612vi/changes/path2/file11.txt
2025/06/04 01:56:36 INFO  : - Path1    Queue copy to Path2       - TestPutio:rclone-test-husosaw9buto/015612vi/changes/path2/file2.txt
2025/06/04 01:56:36 INFO  : - Path2    Queue delete              - TestPutio:rclone-test-husosaw9buto/015612vi/changes/path2/file4.txt
2025/06/04 01:56:36 NOTICE: - WARNING  New or changed in both paths       - file5.txt
2025/06/04 01:56:36 NOTICE: - Path1    Renaming Path1 copy                - /tmp/015612vi/changes/path1/file5.txt.conflict1
2025/06/04 01:56:36 INFO  : file5.txt: Moved (server-side) to: file5.txt.conflict1
2025/06/04 01:56:36 NOTICE: - Path1    Queue copy to Path2       - TestPutio:rclone-test-husosaw9buto/015612vi/changes/path2/file5.txt.conflict1
2025/06/04 01:56:36 NOTICE: - Path2    Renaming Path2 copy                - TestPutio:rclone-test-husosaw9buto/015612vi/changes/path2/file5.txt.conflict2
2025/06/04 01:56:36 INFO  : file5.txt: Moved (server-side) to: file5.txt.conflict2
2025/06/04 01:56:36 NOTICE: - Path2    Queue copy to Path1       - /tmp/015612vi/changes/path1/file5.txt.conflict2
2025/06/04 01:56:36 INFO  : - Path2    Queue copy to Path1       - /tmp/015612vi/changes/path1/file6.txt
2025/06/04 01:56:36 INFO  : - Path1    Queue copy to Path2       - TestPutio:rclone-test-husosaw9buto/015612vi/changes/path2/file7.txt
2025/06/04 01:56:36 INFO  : - Path2    Queue copy to Path1       - /tmp/015612vi/changes/path1/file1.txt
2025/06/04 01:56:36 INFO  : - Path2    Queue copy to Path1       - /tmp/015612vi/changes/path1/file10.txt
2025/06/04 01:56:36 INFO  : - Path1    Queue delete              - /tmp/015612vi/changes/path1/file3.txt
2025/06/04 01:56:36 INFO  : - Path2    Do queued copies to                - Path1
2025/06/04 01:56:37 INFO  : file6.txt: Copied (new)
2025/06/04 01:56:37 INFO  : file10.txt: Copied (new)
2025/06/04 01:56:37 INFO  : file1.txt: Copied (replaced existing)
2025/06/04 01:56:37 INFO  : file5.txt.conflict2: Copied (new)
2025/06/04 01:56:37 INFO  : file3.txt: Deleted
2025/06/04 01:56:37 INFO  : - Path1    Do queued copies to                - Path2
2025/06/04 01:56:38 INFO  : file11.txt: Copied (new)
2025/06/04 01:56:38 INFO  : file2.txt: Copied (replaced existing)
2025/06/04 01:56:38 INFO  : file5.txt.conflict1: Copied (new)
2025/06/04 01:56:38 INFO  : file7.txt: Copied (new)
2025/06/04 01:56:38 INFO  : file4.txt: Deleted
2025/06/04 01:56:38 INFO  : Updating listings
2025/06/04 01:56:38 INFO  : Validating listings for Path1 "/tmp/015612vi/changes/path1/" vs Path2 "TestPutio:rclone-test-husosaw9buto/015612vi/changes/path2/"
2025/06/04 01:56:38 INFO  : Bisync successful
    bisync_test.go:560: TEST changes PASSED
=== RUN   TestBisyncLocalRemote/max_delete_path2_force
2025/06/04 01:56:38 ERROR : error listing: directory not found
2025/06/04 01:56:38 ERROR : error listing: directory not found
2025/06/04 01:56:38 NOTICE: checking initFs Local file system at /tmp/015612vi/initdir/test_max_delete_path2_force-naxiwef8
2025/06/04 01:56:38 NOTICE: checking Path1 Local file system at /tmp/015612vi/max_delete_path2_force/path1
2025/06/04 01:56:40 ERROR : file4.txt: Failed to copy: unexpected status code (404) response while doing PATCH to https://s68.put.io/files/657890f3cdb2fab3fa17bf8a823817d83ed6ed3c
2025/06/04 01:56:40 ERROR : file5.txt: Failed to copy: unexpected status code (404) response while doing PATCH to https://s75.put.io/files/fe9d1a35560f62b5c0f25d4108c52b8032625ccd
    bisync_test.go:1943: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:1943
        	            				/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:461
        	            				/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:358
        	Error:      	Received unexpected error:
        	            	unexpected status code (404) response while doing PATCH to https://s75.put.io/files/fe9d1a35560f62b5c0f25d4108c52b8032625ccd
        	Test:       	TestBisyncLocalRemote/max_delete_path2_force
        	Messages:   	setting up path2
2025/06/04 01:56:41 NOTICE: checking path2 Putio root 'rclone-test-husosaw9buto/015612vi/max_delete_path2_force/path2'
    fstest.go:292: Sleeping for 1s for list eventual consistency: 1/3
    fstest.go:295: Flushing the directory cache
    fstest.go:292: Sleeping for 2s for list eventual consistency: 2/3
    fstest.go:295: Flushing the directory cache
    fstest.go:292: Sleeping for 4s for list eventual consistency: 3/3
    fstest.go:295: Flushing the directory cache
    fstest.go:299: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:299
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:332
        	            				/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:463
        	            				/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:358
        	Error:      	Should be true
        	Test:       	TestBisyncLocalRemote/max_delete_path2_force
        	Messages:   	listing wrong, want
        	            	  file1.txt (0), file2.txt (0), file3.txt (0), file4.txt (0), file5.txt (0), file6.txt (0), file7.txt (0), file8.txt (0), file9.txt (109) got
        	            	  file1.txt (0), file2.txt (0), file3.txt (0), file6.txt (0), file7.txt (0), file8.txt (0), file9.txt (109)
    fstest.go:197: Not found "file5.txt"
    fstest.go:197: Not found "file4.txt"
    fstest.go:200: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:200
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:304
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:332
        	            				/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:463
        	            				/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:358
        	Error:      	Not equal: 
        	            	expected: 0
        	            	actual  : 2
        	Test:       	TestBisyncLocalRemote/max_delete_path2_force
        	Messages:   	2 objects not found
2025/06/04 01:56:49 NOTICE: (01)  : test max-delete-path2-force
2025/06/04 01:56:49 NOTICE: (02)  : test initial bisync
2025/06/04 01:56:49 NOTICE: (03)  : bisync resync
2025/06/04 01:56:50 INFO  : Setting --ignore-listing-checksum as neither --checksum nor --compare checksum are set.
2025/06/04 01:56:50 INFO  : Bisyncing with Comparison Settings: 
{
	"Modtime": true,
	"Size": true,
	"Checksum": false,
	"HashType1": 0,
	"HashType2": 0,
	"NoSlowHash": false,
	"SlowHashSyncOnly": false,
	"SlowHashDetected": true,
	"DownloadHash": false
}
2025/06/04 01:56:50 INFO  : Synching Path1 "/tmp/015612vi/max_delete_path2_force/path1/" with Path2 "TestPutio:rclone-test-husosaw9buto/015612vi/max_delete_path2_force/path2/"
2025/06/04 01:56:50 INFO  : Copying Path2 files to Path1
2025/06/04 01:56:50 INFO  : - Path2    Resync is copying files to         - Path1
2025/06/04 01:56:50 INFO  : - Path1    Resync is copying files to         - Path2
2025/06/04 01:56:50 INFO  : file4.txt: Copied (new)
2025/06/04 01:56:51 INFO  : file5.txt: Copied (new)
2025/06/04 01:56:51 INFO  : Resync updating listings
2025/06/04 01:56:51 INFO  : Validating listings for Path1 "/tmp/015612vi/max_delete_path2_force/path1/" vs Path2 "TestPutio:rclone-test-husosaw9buto/015612vi/max_delete_path2_force/path2/"
2025/06/04 01:56:51 INFO  : Bisync successful
2025/06/04 01:56:51 NOTICE: (04)  : test delete >50% of remote files
2025/06/04 01:56:51 NOTICE: (05)  : delete-file TestPutio:rclone-test-husosaw9buto/015612vi/max_delete_path2_force/path2/file1.txt
2025/06/04 01:56:51 NOTICE: (06)  : delete-file TestPutio:rclone-test-husosaw9buto/015612vi/max_delete_path2_force/path2/file2.txt
2025/06/04 01:56:51 NOTICE: (07)  : delete-file TestPutio:rclone-test-husosaw9buto/015612vi/max_delete_path2_force/path2/file3.txt
2025/06/04 01:56:51 NOTICE: (08)  : delete-file TestPutio:rclone-test-husosaw9buto/015612vi/max_delete_path2_force/path2/file4.txt
2025/06/04 01:56:51 NOTICE: (09)  : delete-file TestPutio:rclone-test-husosaw9buto/015612vi/max_delete_path2_force/path2/file5.txt
2025/06/04 01:56:52 NOTICE: (10)  : test sync should fail due to too many path2 deletes
2025/06/04 01:56:52 NOTICE: (11)  : bisync
2025/06/04 01:56:53 INFO  : Setting --ignore-listing-checksum as neither --checksum nor --compare checksum are set.
2025/06/04 01:56:53 INFO  : Bisyncing with Comparison Settings: 
{
	"Modtime": true,
	"Size": true,
	"Checksum": false,
	"HashType1": 0,
	"HashType2": 0,
	"NoSlowHash": false,
	"SlowHashSyncOnly": false,
	"SlowHashDetected": true,
	"DownloadHash": false
}
2025/06/04 01:56:53 INFO  : Synching Path1 "/tmp/015612vi/max_delete_path2_force/path1/" with Path2 "TestPutio:rclone-test-husosaw9buto/015612vi/max_delete_path2_force/path2/"
2025/06/04 01:56:53 INFO  : Building Path1 and Path2 listings
2025/06/04 01:56:53 INFO  : Path1 checking for diffs
2025/06/04 01:56:53 INFO  : Path2 checking for diffs
2025/06/04 01:56:53 INFO  : - Path2    File was deleted          - file1.txt
2025/06/04 01:56:53 INFO  : - Path2    File was deleted          - file2.txt
2025/06/04 01:56:53 INFO  : - Path2    File was deleted          - file3.txt
2025/06/04 01:56:53 INFO  : - Path2    File was deleted          - file4.txt
2025/06/04 01:56:53 INFO  : - Path2    File was deleted          - file5.txt
2025/06/04 01:56:53 INFO  : Path2:    5 changes:    0 new,    0 modified,    5 deleted
2025/06/04 01:56:53 ERROR : Safety abort: too many deletes (>50%, 5 of 9) on Path2 "TestPutio:rclone-test-husosaw9buto/015612vi/max_delete_path2_force/path2/". Run with --force if desired.
2025/06/04 01:56:53 NOTICE: Bisync aborted. Please try again.
2025/06/04 01:56:53 NOTICE: Bisync error: too many deletes
2025/06/04 01:56:53 NOTICE: (12)  : copy-listings initial-fail
2025/06/04 01:56:53 NOTICE: (13)  : test apply force option. sync should run.
2025/06/04 01:56:53 NOTICE: (14)  : bisync force
2025/06/04 01:56:53 INFO  : Setting --ignore-listing-checksum as neither --checksum nor --compare checksum are set.
2025/06/04 01:56:53 INFO  : Bisyncing with Comparison Settings: 
{
	"Modtime": true,
	"Size": true,
	"Checksum": false,
	"HashType1": 0,
	"HashType2": 0,
	"NoSlowHash": false,
	"SlowHashSyncOnly": false,
	"SlowHashDetected": true,
	"DownloadHash": false
}
2025/06/04 01:56:53 INFO  : Synching Path1 "/tmp/015612vi/max_delete_path2_force/path1/" with Path2 "TestPutio:rclone-test-husosaw9buto/015612vi/max_delete_path2_force/path2/"
2025/06/04 01:56:53 INFO  : Building Path1 and Path2 listings
2025/06/04 01:56:53 INFO  : Path1 checking for diffs
2025/06/04 01:56:53 INFO  : Path2 checking for diffs
2025/06/04 01:56:53 INFO  : - Path2    File was deleted          - file1.txt
2025/06/04 01:56:53 INFO  : - Path2    File was deleted          - file2.txt
2025/06/04 01:56:53 INFO  : - Path2    File was deleted          - file3.txt
2025/06/04 01:56:53 INFO  : - Path2    File was deleted          - file4.txt
2025/06/04 01:56:53 INFO  : - Path2    File was deleted          - file5.txt
2025/06/04 01:56:53 INFO  : Path2:    5 changes:    0 new,    0 modified,    5 deleted
2025/06/04 01:56:53 INFO  : Applying changes
2025/06/04 01:56:53 INFO  : - Path1    Queue delete              - /tmp/015612vi/max_delete_path2_force/path1/file1.txt
2025/06/04 01:56:53 INFO  : - Path1    Queue delete              - /tmp/015612vi/max_delete_path2_force/path1/file2.txt
2025/06/04 01:56:53 INFO  : - Path1    Queue delete              - /tmp/015612vi/max_delete_path2_force/path1/file3.txt
2025/06/04 01:56:53 INFO  : - Path1    Queue delete              - /tmp/015612vi/max_delete_path2_force/path1/file4.txt
2025/06/04 01:56:53 INFO  : - Path1    Queue delete              - /tmp/015612vi/max_delete_path2_force/path1/file5.txt
2025/06/04 01:56:53 INFO  : - Path2    Do queued copies to                - Path1
2025/06/04 01:56:53 INFO  : file3.txt: Deleted
2025/06/04 01:56:53 INFO  : file4.txt: Deleted
2025/06/04 01:56:53 INFO  : file5.txt: Deleted
2025/06/04 01:56:53 INFO  : file1.txt: Deleted
2025/06/04 01:56:53 INFO  : file2.txt: Deleted
2025/06/04 01:56:53 INFO  : Updating listings
2025/06/04 01:56:54 INFO  : Validating listings for Path1 "/tmp/015612vi/max_delete_path2_force/path1/" vs Path2 "TestPutio:rclone-test-husosaw9buto/015612vi/max_delete_path2_force/path2/"
2025/06/04 01:56:54 INFO  : Bisync successful
    bisync_test.go:560: TEST max_delete_path2_force PASSED
--- FAIL: TestBisyncLocalRemote (41.76s)
    --- SKIP: TestBisyncLocalRemote/backupdir (4.57s)
    --- FAIL: TestBisyncLocalRemote/changes (21.05s)
    --- FAIL: TestBisyncLocalRemote/max_delete_path2_force (15.78s)
=== RUN   TestBisyncRemoteRemote
2025/06/04 01:56:54 NOTICE: remote: TestPutio:rclone-test-cubobeq2foba
=== RUN   TestBisyncRemoteRemote/check_access_filters
2025/06/04 01:56:56 ERROR : error listing: directory not found
2025/06/04 01:56:56 ERROR : error listing: directory not found
2025/06/04 01:56:56 NOTICE: checking initFs Local file system at /tmp/015654pa/initdir/test_check_access_filters-bopecut0
2025/06/04 01:57:02 NOTICE: checking Path1 Putio root 'rclone-test-cubobeq2foba/015654pa/check_access_filters/path1'
2025/06/04 01:57:06 ERROR : subdir-not/subdir-not2/RCLONE_TEST: Failed to copy: unexpected status code (404) response while doing HEAD to https://s95.put.io/files/cbddc0820ca8ee04f6dfe1670da34eea70299ad7
    bisync_test.go:1943: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:1943
        	            				/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:461
        	            				/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:358
        	Error:      	Received unexpected error:
        	            	unexpected status code (404) response while doing HEAD to https://s95.put.io/files/cbddc0820ca8ee04f6dfe1670da34eea70299ad7
        	Test:       	TestBisyncRemoteRemote/check_access_filters
        	Messages:   	setting up path2
2025/06/04 01:57:07 NOTICE: checking path2 Putio root 'rclone-test-cubobeq2foba/015654pa/check_access_filters/path2'
    fstest.go:292: Sleeping for 1s for list eventual consistency: 1/3
    fstest.go:295: Flushing the directory cache
    fstest.go:292: Sleeping for 2s for list eventual consistency: 2/3
    fstest.go:295: Flushing the directory cache
    fstest.go:292: Sleeping for 4s for list eventual consistency: 3/3
    fstest.go:295: Flushing the directory cache
    fstest.go:299: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:299
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:332
        	            				/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:463
        	            				/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:358
        	Error:      	Should be true
        	Test:       	TestBisyncRemoteRemote/check_access_filters
        	Messages:   	listing wrong, want
        	            	  RCLONE_TEST (109), file1.txt (0), file2.txt (0), file3.txt (0), file4.txt (0), subdir-not/RCLONE_TEST (109), subdir-not/file20.txt (0), subdir-not/subdir-not2/RCLONE_TEST (109), subdir-not/subdir-not2/file30.txt (0), subdir/RCLONE_TEST (109), subdir/file20.txt (0), subdir/subdirA/RCLONE_TEST (109), subdir/subdirA/file30.txt (0), subdir/subdirB/RCLONE_TEST (109), subdir/subdirB/file30.txt (0), subdirX/RCLONE_TEST (109), subdirX/file20.txt (0), subdirX/subdirX1/RCLONE_TEST (109), subdirX/subdirX1/file30.txt (0) got
        	            	  RCLONE_TEST (109), file1.txt (0), file2.txt (0), file3.txt (0), file4.txt (0), subdir-not/RCLONE_TEST (109), subdir-not/file20.txt (0), subdir-not/subdir-not2/file30.txt (0), subdir/RCLONE_TEST (109), subdir/file20.txt (0), subdir/subdirA/RCLONE_TEST (109), subdir/subdirA/file30.txt (0), subdir/subdirB/RCLONE_TEST (109), subdir/subdirB/file30.txt (0), subdirX/RCLONE_TEST (109), subdirX/file20.txt (0), subdirX/subdirX1/RCLONE_TEST (109), subdirX/subdirX1/file30.txt (0)
    fstest.go:197: Not found "subdir-not/subdir-not2/RCLONE_TEST"
    fstest.go:200: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:200
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:304
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:332
        	            				/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:463
        	            				/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:358
        	Error:      	Not equal: 
        	            	expected: 0
        	            	actual  : 1
        	Test:       	TestBisyncRemoteRemote/check_access_filters
        	Messages:   	1 objects not found
2025/06/04 01:57:15 NOTICE: (01)  : test check-access-filters
2025/06/04 01:57:15 NOTICE: (02)  : test EXCLUDE - OTHER TESTS
2025/06/04 01:57:15 NOTICE: (03)  : copy-file /tmp/015654pa/datadir/test_check_access_filters-galajaj8/exclude-other-filtersfile.txt /tmp/015654pa/workdir/
2025/06/04 01:57:15 NOTICE: (04)  : test resync to get the filters file md5 built.
2025/06/04 01:57:15 NOTICE: (05)  : bisync resync filters-file=/tmp/015654pa/workdir/exclude-other-filtersfile.txt
2025/06/04 01:57:17 INFO  : Setting --ignore-listing-checksum as neither --checksum nor --compare checksum are set.
2025/06/04 01:57:17 INFO  : Bisyncing with Comparison Settings: 
{
	"Modtime": true,
	"Size": true,
	"Checksum": false,
	"HashType1": 0,
	"HashType2": 0,
	"NoSlowHash": false,
	"SlowHashSyncOnly": false,
	"SlowHashDetected": false,
	"DownloadHash": false
}
2025/06/04 01:57:17 INFO  : Synching Path1 "TestPutio:rclone-test-cubobeq2foba/015654pa/check_access_filters/path1/" with Path2 "TestPutio:rclone-test-cubobeq2foba/015654pa/check_access_filters/path2/"
2025/06/04 01:57:17 INFO  : Using filters file /tmp/015654pa/workdir/exclude-other-filtersfile.txt
2025/06/04 01:57:17 INFO  : Storing filters file hash to /tmp/015654pa/workdir/exclude-other-filtersfile.txt.md5
2025/06/04 01:57:17 INFO  : Copying Path2 files to Path1
2025/06/04 01:57:17 INFO  : - Path2    Resync is copying files to         - Path1
2025/06/04 01:57:18 INFO  : - Path1    Resync is copying files to         - Path2
2025/06/04 01:57:18 INFO  : Resync updating listings
2025/06/04 01:57:18 INFO  : Validating listings for Path1 "TestPutio:rclone-test-cubobeq2foba/015654pa/check_access_filters/path1/" vs Path2 "TestPutio:rclone-test-cubobeq2foba/015654pa/check_access_filters/path2/"
2025/06/04 01:57:18 INFO  : Bisync successful
2025/06/04 01:57:18 NOTICE: (06)  : test EXCLUDE - test filters for check access
2025/06/04 01:57:18 NOTICE: (07)  : bisync check-access filters-file=/tmp/015654pa/workdir/exclude-other-filtersfile.txt
2025/06/04 01:57:20 INFO  : Setting --ignore-listing-checksum as neither --checksum nor --compare checksum are set.
2025/06/04 01:57:20 INFO  : Bisyncing with Comparison Settings: 
{
	"Modtime": true,
	"Size": true,
	"Checksum": false,
	"HashType1": 0,
	"HashType2": 0,
	"NoSlowHash": false,
	"SlowHashSyncOnly": false,
	"SlowHashDetected": false,
	"DownloadHash": false
}
2025/06/04 01:57:20 INFO  : Synching Path1 "TestPutio:rclone-test-cubobeq2foba/015654pa/check_access_filters/path1/" with Path2 "TestPutio:rclone-test-cubobeq2foba/015654pa/check_access_filters/path2/"
2025/06/04 01:57:20 INFO  : Using filters file /tmp/015654pa/workdir/exclude-other-filtersfile.txt
2025/06/04 01:57:20 INFO  : Building Path1 and Path2 listings
2025/06/04 01:57:20 INFO  : Path1 checking for diffs
2025/06/04 01:57:20 INFO  : Path2 checking for diffs
2025/06/04 01:57:20 INFO  : Checking access health
2025/06/04 01:57:20 INFO  : Found 3 matching "RCLONE_TEST" files on both paths
2025/06/04 01:57:20 INFO  : No changes found
2025/06/04 01:57:20 INFO  : Updating listings
2025/06/04 01:57:20 INFO  : Validating listings for Path1 "TestPutio:rclone-test-cubobeq2foba/015654pa/check_access_filters/path1/" vs Path2 "TestPutio:rclone-test-cubobeq2foba/015654pa/check_access_filters/path2/"
2025/06/04 01:57:20 INFO  : Bisync successful
2025/06/04 01:57:20 NOTICE: (08)  : copy-listings exclude-initial
2025/06/04 01:57:20 NOTICE: (09)  : test EXCLUDE - delete RCLONE_TEST files in excluded directories
2025/06/04 01:57:20 NOTICE: (10)  : delete-file TestPutio:rclone-test-cubobeq2foba/015654pa/check_access_filters/path2/subdir/subdirA/RCLONE_TEST
2025/06/04 01:57:21 NOTICE: (11)  : delete-file TestPutio:rclone-test-cubobeq2foba/015654pa/check_access_filters/path1/subdir-not/RCLONE_TEST
2025/06/04 01:57:22 NOTICE: (12)  : delete-file TestPutio:rclone-test-cubobeq2foba/015654pa/check_access_filters/path2/subdir-not/subdir-not2/RCLONE_TEST
    bisync_test.go:495: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:495
        	            				/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:358
        	Error:      	test step failed
        	Test:       	TestBisyncRemoteRemote/check_access_filters
        	Messages:   	step 12 failed: object not found
=== RUN   TestBisyncRemoteRemote/concurrent
2025/06/04 01:57:23 ERROR : error listing: directory not found
2025/06/04 01:57:23 ERROR : error listing: directory not found
2025/06/04 01:57:23 NOTICE: checking initFs Local file system at /tmp/015654pa/initdir/test_concurrent-qozevah8
2025/06/04 01:57:26 NOTICE: checking Path1 Putio root 'rclone-test-cubobeq2foba/015654pa/concurrent/path1'
2025/06/04 01:57:28 NOTICE: checking path2 Putio root 'rclone-test-cubobeq2foba/015654pa/concurrent/path2'
2025/06/04 01:57:28 NOTICE: (01)  : test concurrent
2025/06/04 01:57:28 NOTICE: (02)  : test initial bisync
2025/06/04 01:57:28 NOTICE: (03)  : bisync resync
2025/06/04 01:57:30 INFO  : Setting --ignore-listing-checksum as neither --checksum nor --compare checksum are set.
2025/06/04 01:57:30 INFO  : Bisyncing with Comparison Settings: 
{
	"Modtime": true,
	"Size": true,
	"Checksum": false,
	"HashType1": 0,
	"HashType2": 0,
	"NoSlowHash": false,
	"SlowHashSyncOnly": false,
	"SlowHashDetected": false,
	"DownloadHash": false
}
2025/06/04 01:57:30 INFO  : Synching Path1 "TestPutio:rclone-test-cubobeq2foba/015654pa/concurrent/path1/" with Path2 "TestPutio:rclone-test-cubobeq2foba/015654pa/concurrent/path2/"
2025/06/04 01:57:30 INFO  : Copying Path2 files to Path1
2025/06/04 01:57:30 INFO  : - Path2    Resync is copying files to         - Path1
2025/06/04 01:57:30 INFO  : - Path1    Resync is copying files to         - Path2
2025/06/04 01:57:30 INFO  : Resync updating listings
2025/06/04 01:57:30 INFO  : Validating listings for Path1 "TestPutio:rclone-test-cubobeq2foba/015654pa/concurrent/path1/" vs Path2 "TestPutio:rclone-test-cubobeq2foba/015654pa/concurrent/path2/"
2025/06/04 01:57:30 INFO  : Bisync successful
2025/06/04 01:57:30 NOTICE: (04)  : test changed on one path - file1
2025/06/04 01:57:30 NOTICE: (05)  : touch-glob 2001-01-02 /tmp/015654pa/datadir/test_concurrent-cipavim6/ file5R.txt
2025/06/04 01:57:30 NOTICE: (06)  : touch-glob 2023-08-26 /tmp/015654pa/datadir/test_concurrent-cipavim6/ file7.txt
2025/06/04 01:57:30 NOTICE: (07)  : copy-as /tmp/015654pa/datadir/test_concurrent-cipavim6/file5R.txt TestPutio:rclone-test-cubobeq2foba/015654pa/concurrent/path2/ file1.txt
2025/06/04 01:57:32 NOTICE: (08)  : test bisync with file changed during
2025/06/04 01:57:32 NOTICE: (09)  : concurrent-func
2025/06/04 01:57:32 NOTICE: (10)  : bisync
2025/06/04 01:57:33 INFO  : Setting --ignore-listing-checksum as neither --checksum nor --compare checksum are set.
2025/06/04 01:57:33 INFO  : Bisyncing with Comparison Settings: 
{
	"Modtime": true,
	"Size": true,
	"Checksum": false,
	"HashType1": 0,
	"HashType2": 0,
	"NoSlowHash": false,
	"SlowHashSyncOnly": false,
	"SlowHashDetected": false,
	"DownloadHash": false
}
2025/06/04 01:57:33 INFO  : Synching Path1 "TestPutio:rclone-test-cubobeq2foba/015654pa/concurrent/path1/" with Path2 "TestPutio:rclone-test-cubobeq2foba/015654pa/concurrent/path2/"
2025/06/04 01:57:33 INFO  : Building Path1 and Path2 listings
2025/06/04 01:57:33 INFO  : Path1 checking for diffs
2025/06/04 01:57:33 INFO  : Path2 checking for diffs
2025/06/04 01:57:33 INFO  : - Path2    File changed: size (larger), time (newer) - file1.txt
2025/06/04 01:57:33 INFO  : Path2:    1 changes:    0 new,    1 modified,    0 deleted
2025/06/04 01:57:33 INFO  : (Modified:    1 newer,    0 older,    1 larger,    0 smaller)
2025/06/04 01:57:33 INFO  : Applying changes
2025/06/04 01:57:33 INFO  : - Path2    Queue copy to Path1       - TestPutio:rclone-test-cubobeq2foba/015654pa/concurrent/path1/file1.txt
2025/06/04 01:57:33 INFO  : - Path2    Do queued copies to                - Path1
2025/06/04 01:57:35 INFO  : file7.txt: Copied (replaced existing) to: file1.txt
2025/06/04 01:57:35 INFO  : file1.txt: Copied (server-side copy)
2025/06/04 01:57:35 INFO  : Updating listings
2025/06/04 01:57:35 INFO  : Validating listings for Path1 "TestPutio:rclone-test-cubobeq2foba/015654pa/concurrent/path1/" vs Path2 "TestPutio:rclone-test-cubobeq2foba/015654pa/concurrent/path2/"
2025/06/04 01:57:35 INFO  : Bisync successful
2025/06/04 01:57:35 NOTICE: (11)  : bisync
2025/06/04 01:57:37 INFO  : Setting --ignore-listing-checksum as neither --checksum nor --compare checksum are set.
2025/06/04 01:57:37 INFO  : Bisyncing with Comparison Settings: 
{
	"Modtime": true,
	"Size": true,
	"Checksum": false,
	"HashType1": 0,
	"HashType2": 0,
	"NoSlowHash": false,
	"SlowHashSyncOnly": false,
	"SlowHashDetected": false,
	"DownloadHash": false
}
2025/06/04 01:57:37 INFO  : Synching Path1 "TestPutio:rclone-test-cubobeq2foba/015654pa/concurrent/path1/" with Path2 "TestPutio:rclone-test-cubobeq2foba/015654pa/concurrent/path2/"
2025/06/04 01:57:37 INFO  : Building Path1 and Path2 listings
2025/06/04 01:57:37 INFO  : Path1 checking for diffs
2025/06/04 01:57:37 INFO  : Path2 checking for diffs
2025/06/04 01:57:37 INFO  : No changes found
2025/06/04 01:57:37 INFO  : Updating listings
2025/06/04 01:57:37 INFO  : Validating listings for Path1 "TestPutio:rclone-test-cubobeq2foba/015654pa/concurrent/path1/" vs Path2 "TestPutio:rclone-test-cubobeq2foba/015654pa/concurrent/path2/"
2025/06/04 01:57:37 INFO  : Bisync successful
    bisync_test.go:560: TEST concurrent PASSED
=== RUN   TestBisyncRemoteRemote/filters
2025/06/04 01:57:38 ERROR : error listing: directory not found
2025/06/04 01:57:38 ERROR : error listing: directory not found
2025/06/04 01:57:38 NOTICE: checking initFs Local file system at /tmp/015654pa/initdir/test_filters-yukamot7
2025/06/04 01:57:41 ERROR : subdir/file20.txt: Failed to copy: unexpected status code (404) response while doing PATCH to https://s101.put.io/files/793b7eecd1acff290d9ea1904ab4ba8423ad22d4
    bisync_test.go:1943: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:1943
        	            				/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:458
        	            				/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:358
        	Error:      	Received unexpected error:
        	            	unexpected status code (404) response while doing PATCH to https://s101.put.io/files/793b7eecd1acff290d9ea1904ab4ba8423ad22d4
        	Test:       	TestBisyncRemoteRemote/filters
        	Messages:   	setting up path1
2025/06/04 01:57:41 NOTICE: checking Path1 Putio root 'rclone-test-cubobeq2foba/015654pa/filters/path1'
    fstest.go:292: Sleeping for 1s for list eventual consistency: 1/3
    fstest.go:295: Flushing the directory cache
    fstest.go:292: Sleeping for 2s for list eventual consistency: 2/3
    fstest.go:295: Flushing the directory cache
    fstest.go:292: Sleeping for 4s for list eventual consistency: 3/3
    fstest.go:295: Flushing the directory cache
    fstest.go:299: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:299
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:332
        	            				/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:460
        	            				/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:358
        	Error:      	Should be true
        	Test:       	TestBisyncRemoteRemote/filters
        	Messages:   	listing wrong, want
        	            	  RCLONE_TEST (109), file1.txt (0), file2.txt (0), file3.txt (0), file4.txt (0), file5.txt (0), file6.txt (0), file7.txt (0), subdir/file20.txt (0) got
        	            	  RCLONE_TEST (109), file1.txt (0), file2.txt (0), file3.txt (0), file4.txt (0), file5.txt (0), file6.txt (0), file7.txt (0)
    fstest.go:197: Not found "subdir/file20.txt"
    fstest.go:200: 
        	Error Trace:	/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:200
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:304
        	            				/home/rclone/go/src/github.com/rclone/rclone/fstest/fstest.go:332
        	            				/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:460
        	            				/home/rclone/go/src/github.com/rclone/rclone/cmd/bisync/bisync_test.go:358
        	Error:      	Not equal: 
        	            	expected: 0
        	            	actual  : 1
        	Test:       	TestBisyncRemoteRemote/filters
        	Messages:   	1 objects not found
2025/06/04 01:57:52 NOTICE: checking path2 Putio root 'rclone-test-cubobeq2foba/015654pa/filters/path2'
2025/06/04 01:57:52 NOTICE: (01)  : test filters
2025/06/04 01:57:52 NOTICE: (02)  : copy-file /tmp/015654pa/datadir/test_filters-tuketih7/filtersfile.flt /tmp/015654pa/workdir/
2025/06/04 01:57:52 NOTICE: (03)  : test resync to force building of the filters md5 hash
2025/06/04 01:57:52 NOTICE: (04)  : bisync filters-file=/tmp/015654pa/workdir/filtersfile.flt resync
2025/06/04 01:57:54 INFO  : Setting --ignore-listing-checksum as neither --checksum nor --compare checksum are set.
2025/06/04 01:57:54 INFO  : Bisyncing with Comparison Settings: 
{
	"Modtime": true,
	"Size": true,
	"Checksum": false,
	"HashType1": 0,
	"HashType2": 0,
	"NoSlowHash": false,
	"SlowHashSyncOnly": false,
	"SlowHashDetected": false,
	"DownloadHash": false
}
2025/06/04 01:57:54 INFO  : Synching Path1 "TestPutio:rclone-test-cubobeq2foba/015654pa/filters/path1/" with Path2 "TestPutio:rclone-test-cubobeq2foba/015654pa/filters/path2/"
2025/06/04 01:57:54 INFO  : Using filters file /tmp/015654pa/workdir/filtersfile.flt
2025/06/04 01:57:54 INFO  : Storing filters file hash to /tmp/015654pa/workdir/filtersfile.flt.md5
2025/06/04 01:57:54 INFO  : Copying Path2 files to Path1
2025/06/04 01:57:54 INFO  : - Path2    Resync is copying files to         - Path1
2025/06/04 01:57:54 INFO  : subdir/file20.txt: Copied (server-side copy)
2025/06/04 01:57:54 INFO  : - Path1    Resync is copying files to         - Path2
2025/06/04 01:57:54 INFO  : Resync updating listings
2025/06/04 01:57:54 INFO  : Validating listings for Path1 "TestPutio:rclone-test-cubobeq2foba/015654pa/filters/path1/" vs Path2 "TestPutio:rclone-test-cubobeq2foba/015654pa/filters/path2/"
2025/06/04 01:57:54 INFO  : Bisync successful
2025/06/04 01:57:54 NOTICE: (05)  : copy-listings resync
2025/06/04 01:57:54 NOTICE: (06)  : test place new files on the remote
2025/06/04 01:57:54 NOTICE: (07)  : touch-glob 2001-01-02 /tmp/015654pa/datadir/test_filters-tuketih7/ fileZ.txt
2025/06/04 01:57:54 NOTICE: (08)  : copy-as /tmp/015654pa/datadir/test_filters-tuketih7/fileZ.txt TestPutio:rclone-test-cubobeq2foba/015654pa/filters/path2/ fileZ.txt
2025/06/04 01:57:56 NOTICE: (09)  : copy-as /tmp/015654pa/datadir/test_filters-tuketih7/fileZ.txt TestPutio:rclone-test-cubobeq2foba/015654pa/filters/path1/subdir fileZ.txt
2025/06/04 01:57:57 NOTICE: (10)  : test bisync with filters-file. path2-side fileZ.txt will be filtered.
2025/06/04 01:57:57 NOTICE: (11)  : bisync filters-file=/tmp/015654pa/workdir/filtersfile.flt
2025/06/04 01:57:59 INFO  : Setting --ignore-listing-checksum as neither --checksum nor --compare checksum are set.
2025/06/04 01:57:59 INFO  : Bisyncing with Comparison Settings: 
{
	"Modtime": true,
	"Size": true,
	"Checksum": false,
	"HashType1": 0,
	"HashType2": 0,
	"NoSlowHash": false,
	"SlowHashSyncOnly": false,
	"SlowHashDetected": false,
	"DownloadHash": false
}
2025/06/04 01:57:59 INFO  : Synching Path1 "TestPutio:rclone-test-cubobeq2foba/015654pa/filters/path1/" with Path2 "TestPutio:rclone-test-cubobeq2foba/015654pa/filters/path2/"
2025/06/04 01:57:59 INFO  : Using filters file /tmp/015654pa/workdir/filtersfile.flt
2025/06/04 01:57:59 INFO  : Building Path1 and Path2 listings
2025/06/04 01:57:59 INFO  : Path1 checking for diffs
2025/06/04 01:57:59 INFO  : - Path1    File is new               - subdir/fileZ.txt
2025/06/04 01:57:59 INFO  : Path1:    1 changes:    1 new,    0 modified,    0 deleted
2025/06/04 01:57:59 INFO  : Path2 checking for diffs
2025/06/04 01:57:59 INFO  : Applying changes
2025/06/04 01:57:59 INFO  : - Path1    Queue copy to Path2       - TestPutio:rclone-test-cubobeq2foba/015654pa/filters/path2/subdir/fileZ.txt
2025/06/04 01:57:59 INFO  : - Path1    Do queued copies to                - Path2
2025/06/04 01:57:59 INFO  : subdir/fileZ.txt: Copied (server-side copy)
2025/06/04 01:57:59 INFO  : Updating listings
2025/06/04 01:57:59 INFO  : Validating listings for Path1 "TestPutio:rclone-test-cubobeq2foba/015654pa/filters/path1/" vs Path2 "TestPutio:rclone-test-cubobeq2foba/015654pa/filters/path2/"
2025/06/04 01:57:59 INFO  : Bisync successful
    bisync_test.go:560: TEST filters PASSED
=== RUN   TestBisyncRemoteRemote/nomodtime
2025/06/04 01:58:01 ERROR : error listing: directory not found
2025/06/04 01:58:01 ERROR : error listing: directory not found
2025/06/04 01:58:01 NOTICE: checking initFs Local file system at /tmp/015654pa/initdir/test_nomodtime-kosubew4
2025/06/04 01:58:03 NOTICE: checking Path1 Putio root 'rclone-test-cubobeq2foba/015654pa/nomodtime/path1'
2025/06/04 01:58:06 NOTICE: checking path2 Putio root 'rclone-test-cubobeq2foba/015654pa/nomodtime/path2'
2025/06/04 01:58:06 NOTICE: (01)  : test changes
2025/06/04 01:58:06 NOTICE: (02)  : test initial bisync
2025/06/04 01:58:06 NOTICE: (03)  : bisync resync nomodtime
2025/06/04 01:58:08 INFO  : Bisyncing with Comparison Settings: 
{
	"Modtime": false,
	"Size": true,
	"Checksum": true,
	"HashType1": 8,
	"HashType2": 8,
	"NoSlowHash": false,
	"SlowHashSyncOnly": false,
	"SlowHashDetected": false,
	"DownloadHash": true
}
2025/06/04 01:58:08 INFO  : Synching Path1 "TestPutio:rclone-test-cubobeq2foba/015654pa/nomodtime/path1/" with Path2 "TestPutio:rclone-test-cubobeq2foba/015654pa/nomodtime/path2/"
2025/06/04 01:58:08 INFO  : Copying Path2 files to Path1
2025/06/04 01:58:08 INFO  : - Path2    Resync is copying files to         - Path1
2025/06/04 01:58:08 INFO  : - Path1    Resync is copying files to         - Path2
2025/06/04 01:58:08 INFO  : Resync updating listings
2025/06/04 01:58:08 INFO  : Validating listings for Path1 "TestPutio:rclone-test-cubobeq2foba/015654pa/nomodtime/path1/" vs Path2 "TestPutio:rclone-test-cubobeq2foba/015654pa/nomodtime/path2/"
2025/06/04 01:58:08 INFO  : Bisync successful
2025/06/04 01:58:08 NOTICE: (04)  : test make modifications on both paths
2025/06/04 01:58:08 NOTICE: (05)  : test new on path2 - file10
2025/06/04 01:58:08 NOTICE: (06)  : copy-file /tmp/015654pa/datadir/test_nomodtime-renuhac7/file10.txt TestPutio:rclone-test-cubobeq2foba/015654pa/nomodtime/path2/
2025/06/04 01:58:09 NOTICE: (07)  : test changed on path2 - file1
2025/06/04 01:58:09 NOTICE: (08)  : copy-file /tmp/015654pa/datadir/test_nomodtime-renuhac7/file1.txt TestPutio:rclone-test-cubobeq2foba/015654pa/nomodtime/path2/
2025/06/04 01:58:10 NOTICE: (09)  : test new on path1 - file11
2025/06/04 01:58:10 NOTICE: (10)  : copy-file /tmp/015654pa/datadir/test_nomodtime-renuhac7/file11.txt TestPutio:rclone-test-cubobeq2foba/015654pa/nomodtime/path1/
2025/06/04 01:58:12 NOTICE: (11)  : test changed on path1 - file2
2025/06/04 01:58:12 NOTICE: (12)  : copy-file /tmp/015654pa/datadir/test_nomodtime-renuhac7/file2.txt TestPutio:rclone-test-cubobeq2foba/015654pa/nomodtime/path1/
2025/06/04 01:58:13 NOTICE: (13)  : test deleted on path2 - file3
2025/06/04 01:58:13 NOTICE: (14)  : delete-file TestPutio:rclone-test-cubobeq2foba/015654pa/nomodtime/path2/file3.txt
2025/06/04 01:58:13 NOTICE: (15)  : test deleted on path1 - file4
2025/06/04 01:58:13 NOTICE: (16)  : delete-file TestPutio:rclone-test-cubobeq2foba/015654pa/nomodtime/path1/file4.txt
2025/06/04 01:58:14 NOTICE: (17)  : test deleted on both paths - file8
2025/06/04 01:58:14 NOTICE: (18)  : delete-file TestPutio:rclone-test-cubobeq2foba/015654pa/nomodtime/path1/file8.txt
2025/06/04 01:58:14 NOTICE: (19)  : delete-file TestPutio:rclone-test-cubobeq2foba/015654pa/nomodtime/path2/file8.txt
2025/06/04 01:58:14 NOTICE: (20)  : test changed on both paths - file5 (file5R, file5L)
2025/06/04 01:58:14 NOTICE: (21)  : copy-as /tmp/015654pa/datadir/test_nomodtime-renuhac7/file5R.txt TestPutio:rclone-test-cubobeq2foba/015654pa/nomodtime/path2/ file5.txt
2025/06/04 01:58:15 NOTICE: (22)  : copy-as /tmp/015654pa/datadir/test_nomodtime-renuhac7/file5L.txt TestPutio:rclone-test-cubobeq2foba/015654pa/nomodtime/path1/ file5.txt
2025/06/04 01:58:17 NOTICE: (23)  : test changed on path2 and deleted on path1 - file6
2025/06/04 01:58:17 NOTICE: (24)  : copy-file /tmp/015654pa/datadir/test_nomodtime-renuhac7/file6.txt TestPutio:rclone-test-cubobeq2foba/015654pa/nomodtime/path2/
2025/06/04 01:58:18 NOTICE: (25)  : delete-file TestPutio:rclone-test-cubobeq2foba/015654pa/nomodtime/path1/file6.txt
2025/06/04 01:58:18 NOTICE: (26)  : test changed on path1 and deleted on path2 - file7
2025/06/04 01:58:18 NOTICE: (27)  : copy-file /tmp/015654pa/datadir/test_nomodtime-renuhac7/file7.txt TestPutio:rclone-test-cubobeq2foba/015654pa/nomodtime/path1/
2025/06/04 01:58:19 NOTICE: (28)  : delete-file TestPutio:rclone-test-cubobeq2foba/015654pa/nomodtime/path2/file7.txt
2025/06/04 01:58:19 NOTICE: (29)  : test bisync run
2025/06/04 01:58:19 NOTICE: (30)  : bisync nomodtime
2025/06/04 01:58:21 INFO  : Bisyncing with Comparison Settings: 
{
	"Modtime": false,
	"Size": true,
	"Checksum": true,
	"HashType1": 8,
	"HashType2": 8,
	"NoSlowHash": false,
	"SlowHashSyncOnly": false,
	"SlowHashDetected": false,
	"DownloadHash": true
}
2025/06/04 01:58:21 INFO  : Synching Path1 "TestPutio:rclone-test-cubobeq2foba/015654pa/nomodtime/path1/" with Path2 "TestPutio:rclone-test-cubobeq2foba/015654pa/nomodtime/path2/"
2025/06/04 01:58:21 INFO  : Building Path1 and Path2 listings
2025/06/04 01:58:21 INFO  : Path1 checking for diffs
2025/06/04 01:58:21 INFO  : - Path1    File changed: size (larger), hash - file2.txt
2025/06/04 01:58:21 INFO  : - Path1    File was deleted          - file4.txt
2025/06/04 01:58:21 INFO  : - Path1    File changed: size (larger), hash - file5.txt
2025/06/04 01:58:21 INFO  : - Path1    File was deleted          - file6.txt
2025/06/04 01:58:21 INFO  : - Path1    File changed: size (larger), hash - file7.txt
2025/06/04 01:58:21 INFO  : - Path1    File was deleted          - file8.txt
2025/06/04 01:58:21 INFO  : - Path1    File is new               - file11.txt
2025/06/04 01:58:21 INFO  : Path1:    7 changes:    1 new,    3 modified,    3 deleted
2025/06/04 01:58:21 INFO  : (Modified:    3 larger,    0 smaller,    3 hash differs)
2025/06/04 01:58:21 INFO  : Path2 checking for diffs
2025/06/04 01:58:21 INFO  : - Path2    File changed: size (larger), hash - file1.txt
2025/06/04 01:58:21 INFO  : - Path2    File was deleted          - file3.txt
2025/06/04 01:58:21 INFO  : - Path2    File changed: size (larger), hash - file5.txt
2025/06/04 01:58:21 INFO  : - Path2    File changed: size (larger), hash - file6.txt
2025/06/04 01:58:21 INFO  : - Path2    File was deleted          - file7.txt
2025/06/04 01:58:21 INFO  : - Path2    File was deleted          - file8.txt
2025/06/04 01:58:21 INFO  : - Path2    File is new               - file10.txt
2025/06/04 01:58:21 INFO  : Path2:    7 changes:    1 new,    3 modified,    3 deleted
2025/06/04 01:58:21 INFO  : (Modified:    3 larger,    0 smaller,    3 hash differs)
2025/06/04 01:58:21 INFO  : Applying changes
2025/06/04 01:58:21 INFO  : - Path1    Queue copy to Path2       - TestPutio:rclone-test-cubobeq2foba/015654pa/nomodtime/path2/file11.txt
2025/06/04 01:58:21 INFO  : - Path1    Queue copy to Path2       - TestPutio:rclone-test-cubobeq2foba/015654pa/nomodtime/path2/file2.txt
2025/06/04 01:58:21 INFO  : - Path2    Queue delete              - TestPutio:rclone-test-cubobeq2foba/015654pa/nomodtime/path2/file4.txt
2025/06/04 01:58:21 NOTICE: - WARNING  New or changed in both paths       - file5.txt
2025/06/04 01:58:21 NOTICE: - Path1    Renaming Path1 copy                - TestPutio:rclone-test-cubobeq2foba/015654pa/nomodtime/path1/file5.txt.conflict1
2025/06/04 01:58:21 INFO  : file5.txt: Moved (server-side) to: file5.txt.conflict1
2025/06/04 01:58:21 NOTICE: - Path1    Queue copy to Path2       - TestPutio:rclone-test-cubobeq2foba/015654pa/nomodtime/path2/file5.txt.conflict1
2025/06/04 01:58:21 NOTICE: - Path2    Renaming Path2 copy                - TestPutio:rclone-test-cubobeq2foba/015654pa/nomodtime/path2/file5.txt.conflict2
2025/06/04 01:58:22 INFO  : file5.txt: Moved (server-side) to: file5.txt.conflict2
2025/06/04 01:58:22 NOTICE: - Path2    Queue copy to Path1       - TestPutio:rclone-test-cubobeq2foba/015654pa/nomodtime/path1/file5.txt.conflict2
2025/06/04 01:58:22 INFO  : - Path2    Queue copy to Path1       - TestPutio:rclone-test-cubobeq2foba/015654pa/nomodtime/path1/file6.txt
2025/06/04 01:58:22 INFO  : - Path1    Queue copy to Path2       - TestPutio:rclone-test-cubobeq2foba/015654pa/nomodtime/path2/file7.txt
2025/06/04 01:58:22 INFO  : - Path2    Queue copy to Path1       - TestPutio:rclone-test-cubobeq2foba/015654pa/nomodtime/path1/file1.txt
2025/06/04 01:58:22 INFO  : - Path2    Queue copy to Path1       - TestPutio:rclone-test-cubobeq2foba/015654pa/nomodtime/path1/file10.txt
2025/06/04 01:58:22 INFO  : - Path1    Queue delete              - TestPutio:rclone-test-cubobeq2foba/015654pa/nomodtime/path1/file3.txt
2025/06/04 01:58:22 INFO  : - Path2    Do queued copies to                - Path1
2025/06/04 01:58:22 INFO  : file10.txt: Copied (server-side copy)
2025/06/04 01:58:22 INFO  : file6.txt: Copied (server-side copy)
2025/06/04 01:58:22 INFO  : file5.txt.conflict2: Copied (server-side copy)
2025/06/04 01:58:22 INFO  : file1.txt: Copied (server-side copy)
2025/06/04 01:58:22 INFO  : file3.txt: Deleted
2025/06/04 01:58:22 INFO  : - Path1    Do queued copies to                - Path2
2025/06/04 01:58:23 INFO  : file11.txt: Copied (server-side copy)
2025/06/04 01:58:23 INFO  : file5.txt.conflict1: Copied (server-side copy)
2025/06/04 01:58:23 INFO  : file7.txt: Copied (server-side copy)
2025/06/04 01:58:24 INFO  : file2.txt: Copied (server-side copy)
2025/06/04 01:58:24 INFO  : file4.txt: Deleted
2025/06/04 01:58:24 INFO  : Updating listings
2025/06/04 01:58:24 INFO  : Validating listings for Path1 "TestPutio:rclone-test-cubobeq2foba/015654pa/nomodtime/path1/" vs Path2 "TestPutio:rclone-test-cubobeq2foba/015654pa/nomodtime/path2/"
2025/06/04 01:58:24 INFO  : Bisync successful
    bisync_test.go:560: TEST nomodtime PASSED
=== RUN   TestBisyncRemoteRemote/normalization
2025/06/04 01:58:25 ERROR : error listing: directory not found
2025/06/04 01:58:25 ERROR : error listing: directory not found
2025/06/04 01:58:25 NOTICE: checking initFs Local file system at /tmp/015654pa/initdir/test_normalization-fexowag3
2025/06/04 01:58:27 NOTICE: checking Path1 Putio root 'rclone-test-cubobeq2foba/015654pa/normalization/path1'
2025/06/04 01:58:29 NOTICE: checking path2 Putio root 'rclone-test-cubobeq2foba/015654pa/normalization/path2'
2025/06/04 01:58:29 NOTICE: (01)  : test normalization
2025/06/04 01:58:29 NOTICE: (02)  : touch-copy 2001-01-02 /tmp/015654pa/datadir/test_normalization-qunafoz2/file1.txt TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path2/
2025/06/04 01:58:30 NOTICE: (03)  : test initial bisync
2025/06/04 01:58:30 NOTICE: (04)  : bisync resync
2025/06/04 01:58:35 INFO  : Setting --ignore-listing-checksum as neither --checksum nor --compare checksum are set.
2025/06/04 01:58:35 INFO  : Bisyncing with Comparison Settings: 
{
	"Modtime": true,
	"Size": true,
	"Checksum": false,
	"HashType1": 0,
	"HashType2": 0,
	"NoSlowHash": false,
	"SlowHashSyncOnly": false,
	"SlowHashDetected": false,
	"DownloadHash": false
}
2025/06/04 01:58:35 INFO  : Synching Path1 "TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path1/" with Path2 "TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path2/"
2025/06/04 01:58:35 INFO  : Copying Path2 files to Path1
2025/06/04 01:58:35 INFO  : - Path2    Resync is copying files to         - Path1
2025/06/04 01:58:35 INFO  : - Path1    Resync is copying files to         - Path2
2025/06/04 01:58:36 INFO  : file1.txt: Copied (server-side copy)
2025/06/04 01:58:36 INFO  : Resync updating listings
2025/06/04 01:58:36 INFO  : Validating listings for Path1 "TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path1/" vs Path2 "TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path2/"
2025/06/04 01:58:36 INFO  : Bisync successful
2025/06/04 01:58:36 NOTICE: (05)  : copy-as-NFC /tmp/015654pa/datadir/test_normalization-qunafoz2/file1.txt TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path1/測試_Русский___ě_áñ👸🏼🧝🏾‍♀️💆🏿‍♂️🐨🤙🏼🤮🧑🏻‍🔧🧑‍🔬éö 測試_Русский___ě_áñ👸🏼🧝🏾‍♀️💆🏿‍♂️🐨🤙🏼🤮🧑🏻‍🔧🧑‍🔬éö.txt
2025/06/04 01:58:38 NOTICE: (06)  : copy-as-NFC /tmp/015654pa/datadir/test_normalization-qunafoz2/file1.txt TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path1/folder éééö.txt
2025/06/04 01:58:39 NOTICE: (07)  : copy-as-NFC /tmp/015654pa/datadir/test_normalization-qunafoz2/file1.txt TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path1/folder HeLlO,wOrLd!.txt
2025/06/04 01:58:40 NOTICE: (08)  : touch-copy 2001-01-03 /tmp/015654pa/datadir/test_normalization-qunafoz2/file1.txt TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path2/
2025/06/04 01:58:42 NOTICE: (09)  : copy-as-NFD /tmp/015654pa/datadir/test_normalization-qunafoz2/file1.txt TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path2/folder éééö.txt
2025/06/04 01:58:43 NOTICE: (10)  : copy-as-NFD /tmp/015654pa/datadir/test_normalization-qunafoz2/file1.txt TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path2/folder hello,WORLD!.txt
2025/06/04 01:58:45 NOTICE: (11)  : test bisync run with fix-case
2025/06/04 01:58:45 NOTICE: (12)  : bisync fix-case
2025/06/04 01:58:50 INFO  : Setting --ignore-listing-checksum as neither --checksum nor --compare checksum are set.
2025/06/04 01:58:50 INFO  : Bisyncing with Comparison Settings: 
{
	"Modtime": true,
	"Size": true,
	"Checksum": false,
	"HashType1": 0,
	"HashType2": 0,
	"NoSlowHash": false,
	"SlowHashSyncOnly": false,
	"SlowHashDetected": false,
	"DownloadHash": false
}
2025/06/04 01:58:50 INFO  : Synching Path1 "TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path1/" with Path2 "TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path2/"
2025/06/04 01:58:50 INFO  : Building Path1 and Path2 listings
2025/06/04 01:58:50 INFO  : Path1 checking for diffs
2025/06/04 01:58:50 INFO  : - Path1    File is new               - folder/HeLlO,wOrLd!.txt
2025/06/04 01:58:50 INFO  : - Path1    File is new               - folder/éééö.txt
2025/06/04 01:58:50 INFO  : - Path1    File is new               - "測試_Русский___ě_áñ👸🏼🧝🏾\u200d♀️💆🏿\u200d♂️🐨🤙🏼🤮🧑🏻\u200d🔧🧑\u200d🔬éö/測試_Русский___ě_áñ👸🏼🧝🏾\u200d♀️💆🏿\u200d♂️🐨🤙🏼🤮🧑🏻\u200d🔧🧑\u200d🔬éö.txt"
2025/06/04 01:58:50 INFO  : Path1:    3 changes:    3 new,    0 modified,    0 deleted
2025/06/04 01:58:50 INFO  : Path2 checking for diffs
2025/06/04 01:58:50 INFO  : - Path2    File changed: size (larger), time (newer) - file1.txt
2025/06/04 01:58:50 INFO  : - Path2    File is new               - folder/hello,WORLD!.txt
2025/06/04 01:58:50 INFO  : - Path2    File is new               - folder/éééö.txt
2025/06/04 01:58:50 INFO  : Path2:    3 changes:    2 new,    1 modified,    0 deleted
2025/06/04 01:58:50 INFO  : (Modified:    1 newer,    0 older,    1 larger,    0 smaller)
2025/06/04 01:58:50 INFO  : Applying changes
2025/06/04 01:58:50 INFO  : Checking potential conflicts...
2025/06/04 01:58:50 NOTICE: Putio root 'rclone-test-cubobeq2foba/015654pa/normalization/path2': 0 differences found
2025/06/04 01:58:50 NOTICE: Putio root 'rclone-test-cubobeq2foba/015654pa/normalization/path2': 2 matching files
2025/06/04 01:58:50 INFO  : Finished checking the potential conflicts. %!s(<nil>)
2025/06/04 01:58:50 NOTICE: - WARNING  New or changed in both paths       - folder/HeLlO,wOrLd!.txt
2025/06/04 01:58:50 INFO  : folder/hello,WORLD!.txt: Files are equal but will copy anyway to fix case to folder/HeLlO,wOrLd!.txt
2025/06/04 01:58:50 NOTICE: - WARNING  New or changed in both paths       - folder/éééö.txt
2025/06/04 01:58:50 INFO  : folder/éééö.txt: Files are equal but will copy anyway to update modtime (will not rename)
2025/06/04 01:58:50 INFO  : - Path2    Queue copy to Path1       - TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path1/folder/éééö.txt
2025/06/04 01:58:50 INFO  : - Path1    Queue copy to Path2       - "TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path2/測試_Русский___ě_áñ👸🏼🧝🏾\u200d♀️💆🏿\u200d♂️🐨🤙🏼🤮🧑🏻\u200d🔧🧑\u200d🔬éö/測試_Русский___ě_áñ👸🏼🧝🏾\u200d♀️💆🏿\u200d♂️🐨🤙🏼🤮🧑🏻\u200d🔧🧑\u200d🔬éö.txt"
2025/06/04 01:58:50 INFO  : - Path2    Queue copy to Path1       - TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path1/file1.txt
2025/06/04 01:58:50 INFO  : - Path2    Do queued copies to                - Path1
2025/06/04 01:58:50 INFO  : folder/éééö.txt: Updated modification time in destination
2025/06/04 01:58:51 INFO  : file1.txt: Copied (server-side copy)
2025/06/04 01:58:51 INFO  : - Path1    Do queued copies to                - Path2
2025/06/04 01:58:51 INFO  : folder/HeLlO,wOrLd!.txt: Updated modification time in destination
2025/06/04 01:58:51 INFO  : folder/hello,WORLD!.txt: Moved (server-side) to: folder/HeLlO,wOrLd!.txt
2025/06/04 01:58:51 INFO  : folder/hello,WORLD!.txt: Fixed case by renaming to: folder/HeLlO,wOrLd!.txt
2025/06/04 01:58:51 INFO  : 測試_Русский___ě_áñ👸🏼🧝🏾‍♀️💆🏿‍♂️🐨🤙🏼🤮🧑🏻‍🔧🧑‍🔬éö/測試_Русский___ě_áñ👸🏼🧝🏾‍♀️💆🏿‍♂️🐨🤙🏼🤮🧑🏻‍🔧🧑‍🔬éö.txt: Copied (server-side copy)
2025/06/04 01:58:51 INFO  : Updating listings
2025/06/04 01:58:51 INFO  : Validating listings for Path1 "TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path1/" vs Path2 "TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path2/"
2025/06/04 01:58:51 INFO  : Bisync successful
2025/06/04 01:58:51 NOTICE: (13)  : purge-children TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path1/
2025/06/04 01:58:52 NOTICE: (14)  : purge-children TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path2/
2025/06/04 01:58:53 NOTICE: (15)  : touch-copy 2001-01-02 /tmp/015654pa/datadir/test_normalization-qunafoz2/file1.txt TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path2/
2025/06/04 01:58:54 NOTICE: (16)  : copy-as-NFC /tmp/015654pa/datadir/test_normalization-qunafoz2/file1.txt TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path2/ file2.txt
2025/06/04 01:58:55 NOTICE: (17)  : copy-as-NFC /tmp/015654pa/datadir/test_normalization-qunafoz2/file1.txt TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path1/ file3.txt
2025/06/04 01:58:56 NOTICE: (18)  : bisync resync
2025/06/04 01:59:02 INFO  : Setting --ignore-listing-checksum as neither --checksum nor --compare checksum are set.
2025/06/04 01:59:02 INFO  : Bisyncing with Comparison Settings: 
{
	"Modtime": true,
	"Size": true,
	"Checksum": false,
	"HashType1": 0,
	"HashType2": 0,
	"NoSlowHash": false,
	"SlowHashSyncOnly": false,
	"SlowHashDetected": false,
	"DownloadHash": false
}
2025/06/04 01:59:02 INFO  : Synching Path1 "TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path1/" with Path2 "TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path2/"
2025/06/04 01:59:02 INFO  : Copying Path2 files to Path1
2025/06/04 01:59:02 INFO  : - Path2    Resync is copying files to         - Path1
2025/06/04 01:59:03 INFO  : file1.txt: Copied (server-side copy)
2025/06/04 01:59:03 INFO  : file2.txt: Copied (server-side copy)
2025/06/04 01:59:03 INFO  : - Path1    Resync is copying files to         - Path2
2025/06/04 01:59:03 INFO  : file3.txt: Copied (server-side copy)
2025/06/04 01:59:03 INFO  : Resync updating listings
2025/06/04 01:59:03 INFO  : Validating listings for Path1 "TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path1/" vs Path2 "TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path2/"
2025/06/04 01:59:03 INFO  : Bisync successful
2025/06/04 01:59:03 NOTICE: (19)  : copy-as-NFC /tmp/015654pa/datadir/test_normalization-qunafoz2/file1.txt TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path1/測試_Руский___ě_áñ👸🏼🧝🏾‍♀️💆🏿‍♂️🐨🤙🏼🤮🧑🏻‍🔧🧑‍🔬éö 測試_Руский___ě_áñ👸🏼🧝🏾‍♀️💆🏿‍♂️🐨🤙🏼🤮🧑🏻‍🔧🧑‍🔬éö.txt
2025/06/04 01:59:05 NOTICE: (20)  : copy-as-NFC /tmp/015654pa/datadir/test_normalization-qunafoz2/file1.txt TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path1/newfolder éééö.txt
2025/06/04 01:59:07 NOTICE: (21)  : copy-as-NFC /tmp/015654pa/datadir/test_normalization-qunafoz2/file1.txt TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path1/newfolder HeLlO,wOrLd!.txt
2025/06/04 01:59:08 NOTICE: (22)  : touch-copy 2001-01-03 /tmp/015654pa/datadir/test_normalization-qunafoz2/file1.txt TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path2/
2025/06/04 01:59:08 NOTICE: (23)  : copy-as-NFD /tmp/015654pa/datadir/test_normalization-qunafoz2/file1.txt TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path2/newfolder éééö.txt
2025/06/04 01:59:10 NOTICE: (24)  : copy-as-NFD /tmp/015654pa/datadir/test_normalization-qunafoz2/file1.txt TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path2/newfolder hello,WORLD!.txt
2025/06/04 01:59:12 NOTICE: (25)  : test bisync run with normalization
2025/06/04 01:59:12 NOTICE: (26)  : bisync norm force
2025/06/04 01:59:17 INFO  : Setting --ignore-listing-checksum as neither --checksum nor --compare checksum are set.
2025/06/04 01:59:17 INFO  : Bisyncing with Comparison Settings: 
{
	"Modtime": true,
	"Size": true,
	"Checksum": false,
	"HashType1": 0,
	"HashType2": 0,
	"NoSlowHash": false,
	"SlowHashSyncOnly": false,
	"SlowHashDetected": false,
	"DownloadHash": false
}
2025/06/04 01:59:17 INFO  : Synching Path1 "TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path1/" with Path2 "TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path2/"
2025/06/04 01:59:17 INFO  : Building Path1 and Path2 listings
2025/06/04 01:59:17 INFO  : Path1 checking for diffs
2025/06/04 01:59:17 INFO  : - Path1    File is new               - newfolder/HeLlO,wOrLd!.txt
2025/06/04 01:59:17 INFO  : - Path1    File is new               - newfolder/éééö.txt
2025/06/04 01:59:17 INFO  : - Path1    File is new               - "測試_Руский___ě_áñ👸🏼🧝🏾\u200d♀️💆🏿\u200d♂️🐨🤙🏼🤮🧑🏻\u200d🔧🧑\u200d🔬éö/測試_Руский___ě_áñ👸🏼🧝🏾\u200d♀️💆🏿\u200d♂️🐨🤙🏼🤮🧑🏻\u200d🔧🧑\u200d🔬éö.txt"
2025/06/04 01:59:17 INFO  : Path1:    3 changes:    3 new,    0 modified,    0 deleted
2025/06/04 01:59:17 INFO  : Path2 checking for diffs
2025/06/04 01:59:17 INFO  : - Path2    File changed: time (newer) - file1.txt
2025/06/04 01:59:17 INFO  : - Path2    File is new               - newfolder/hello,WORLD!.txt
2025/06/04 01:59:17 INFO  : - Path2    File is new               - newfolder/éééö.txt
2025/06/04 01:59:17 INFO  : Path2:    3 changes:    2 new,    1 modified,    0 deleted
2025/06/04 01:59:17 INFO  : (Modified:    1 newer,    0 older)
2025/06/04 01:59:17 INFO  : Applying changes
2025/06/04 01:59:17 INFO  : Checking potential conflicts...
2025/06/04 01:59:17 NOTICE: Putio root 'rclone-test-cubobeq2foba/015654pa/normalization/path2': 0 differences found
2025/06/04 01:59:17 NOTICE: Putio root 'rclone-test-cubobeq2foba/015654pa/normalization/path2': 2 matching files
2025/06/04 01:59:17 INFO  : Finished checking the potential conflicts. %!s(<nil>)
2025/06/04 01:59:17 NOTICE: - WARNING  New or changed in both paths       - newfolder/HeLlO,wOrLd!.txt
2025/06/04 01:59:17 INFO  : newfolder/HeLlO,wOrLd!.txt: Files are equal but will copy anyway to update modtime (will not rename)
2025/06/04 01:59:17 INFO  : - Path2    Queue copy to Path1       - TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path1/newfolder/HeLlO,wOrLd!.txt
2025/06/04 01:59:17 NOTICE: - WARNING  New or changed in both paths       - newfolder/éééö.txt
2025/06/04 01:59:17 INFO  : newfolder/éééö.txt: Files are equal but will copy anyway to update modtime (will not rename)
2025/06/04 01:59:17 INFO  : - Path2    Queue copy to Path1       - TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path1/newfolder/éééö.txt
2025/06/04 01:59:17 INFO  : - Path1    Queue copy to Path2       - "TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path2/測試_Руский___ě_áñ👸🏼🧝🏾\u200d♀️💆🏿\u200d♂️🐨🤙🏼🤮🧑🏻\u200d🔧🧑\u200d🔬éö/測試_Руский___ě_áñ👸🏼🧝🏾\u200d♀️💆🏿\u200d♂️🐨🤙🏼🤮🧑🏻\u200d🔧🧑\u200d🔬éö.txt"
2025/06/04 01:59:17 INFO  : - Path2    Queue copy to Path1       - TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path1/file1.txt
2025/06/04 01:59:17 INFO  : - Path2    Do queued copies to                - Path1
2025/06/04 01:59:17 INFO  : file1.txt: Updated modification time in destination
2025/06/04 01:59:17 INFO  : newfolder/éééö.txt: Updated modification time in destination
2025/06/04 01:59:17 INFO  : newfolder/hello,WORLD!.txt: Updated modification time in destination
2025/06/04 01:59:17 INFO  : - Path1    Do queued copies to                - Path2
2025/06/04 01:59:18 INFO  : 測試_Руский___ě_áñ👸🏼🧝🏾‍♀️💆🏿‍♂️🐨🤙🏼🤮🧑🏻‍🔧🧑‍🔬éö/測試_Руский___ě_áñ👸🏼🧝🏾‍♀️💆🏿‍♂️🐨🤙🏼🤮🧑🏻‍🔧🧑‍🔬éö.txt: Copied (server-side copy)
2025/06/04 01:59:18 INFO  : Updating listings
2025/06/04 01:59:18 INFO  : Validating listings for Path1 "TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path1/" vs Path2 "TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path2/"
2025/06/04 01:59:18 INFO  : Bisync successful
2025/06/04 01:59:18 NOTICE: (27)  : test resync
2025/06/04 01:59:18 NOTICE: (28)  : bisync resync norm
2025/06/04 01:59:23 INFO  : Setting --ignore-listing-checksum as neither --checksum nor --compare checksum are set.
2025/06/04 01:59:23 INFO  : Bisyncing with Comparison Settings: 
{
	"Modtime": true,
	"Size": true,
	"Checksum": false,
	"HashType1": 0,
	"HashType2": 0,
	"NoSlowHash": false,
	"SlowHashSyncOnly": false,
	"SlowHashDetected": false,
	"DownloadHash": false
}
2025/06/04 01:59:23 INFO  : Synching Path1 "TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path1/" with Path2 "TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path2/"
2025/06/04 01:59:23 INFO  : Copying Path2 files to Path1
2025/06/04 01:59:23 INFO  : - Path2    Resync is copying files to         - Path1
2025/06/04 01:59:23 INFO  : - Path1    Resync is copying files to         - Path2
2025/06/04 01:59:23 INFO  : Resync updating listings
2025/06/04 01:59:24 INFO  : Validating listings for Path1 "TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path1/" vs Path2 "TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path2/"
2025/06/04 01:59:24 INFO  : Bisync successful
2025/06/04 01:59:24 NOTICE: (29)  : test changed on one path
2025/06/04 01:59:24 NOTICE: (30)  : touch-copy 2001-01-05 /tmp/015654pa/datadir/test_normalization-qunafoz2/file1.txt TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path2/
2025/06/04 01:59:24 NOTICE: (31)  : copy-as-NFC /tmp/015654pa/datadir/test_normalization-qunafoz2/file1.txt TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path1/測試_Руский___ě_áñ👸🏼🧝🏾‍♀️💆🏿‍♂️🐨🤙🏼🤮🧑🏻‍🔧🧑‍🔬éö 測試_Руский___ě_áñ👸🏼🧝🏾‍♀️💆🏿‍♂️🐨🤙🏼🤮🧑🏻‍🔧🧑‍🔬éö.txt
2025/06/04 01:59:25 NOTICE: (32)  : copy-as-NFC /tmp/015654pa/datadir/test_normalization-qunafoz2/file1.txt TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path1/newfolder éééö.txt
2025/06/04 01:59:25 NOTICE: (33)  : copy-as-NFC /tmp/015654pa/datadir/test_normalization-qunafoz2/file1.txt TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path1/newfolder HeLlO,wOrLd!.txt
2025/06/04 01:59:26 NOTICE: (34)  : bisync norm
2025/06/04 01:59:31 INFO  : Setting --ignore-listing-checksum as neither --checksum nor --compare checksum are set.
2025/06/04 01:59:31 INFO  : Bisyncing with Comparison Settings: 
{
	"Modtime": true,
	"Size": true,
	"Checksum": false,
	"HashType1": 0,
	"HashType2": 0,
	"NoSlowHash": false,
	"SlowHashSyncOnly": false,
	"SlowHashDetected": false,
	"DownloadHash": false
}
2025/06/04 01:59:31 INFO  : Synching Path1 "TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path1/" with Path2 "TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path2/"
2025/06/04 01:59:31 INFO  : Building Path1 and Path2 listings
2025/06/04 01:59:31 INFO  : Path1 checking for diffs
2025/06/04 01:59:31 INFO  : - Path1    File changed: time (newer) - newfolder/HeLlO,wOrLd!.txt
2025/06/04 01:59:31 INFO  : - Path1    File changed: time (newer) - newfolder/éééö.txt
2025/06/04 01:59:31 INFO  : - Path1    File changed: time (newer) - "測試_Руский___ě_áñ👸🏼🧝🏾\u200d♀️💆🏿\u200d♂️🐨🤙🏼🤮🧑🏻\u200d🔧🧑\u200d🔬éö/測試_Руский___ě_áñ👸🏼🧝🏾\u200d♀️💆🏿\u200d♂️🐨🤙🏼🤮🧑🏻\u200d🔧🧑\u200d🔬éö.txt"
2025/06/04 01:59:31 INFO  : Path1:    3 changes:    0 new,    3 modified,    0 deleted
2025/06/04 01:59:31 INFO  : (Modified:    3 newer,    0 older)
2025/06/04 01:59:31 INFO  : Path2 checking for diffs
2025/06/04 01:59:31 INFO  : - Path2    File changed: time (newer) - file1.txt
2025/06/04 01:59:31 INFO  : Path2:    1 changes:    0 new,    1 modified,    0 deleted
2025/06/04 01:59:31 INFO  : (Modified:    1 newer,    0 older)
2025/06/04 01:59:31 INFO  : Applying changes
2025/06/04 01:59:31 INFO  : - Path1    Queue copy to Path2       - TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path2/newfolder/hello,WORLD!.txt
2025/06/04 01:59:31 INFO  : - Path1    Queue copy to Path2       - TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path2/newfolder/éééö.txt
2025/06/04 01:59:31 INFO  : - Path1    Queue copy to Path2       - "TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path2/測試_Руский___ě_áñ👸🏼🧝🏾\u200d♀️💆🏿\u200d♂️🐨🤙🏼🤮🧑🏻\u200d🔧🧑\u200d🔬éö/測試_Руский___ě_áñ👸🏼🧝🏾\u200d♀️💆🏿\u200d♂️🐨🤙🏼🤮🧑🏻\u200d🔧🧑\u200d🔬éö.txt"
2025/06/04 01:59:31 INFO  : - Path2    Queue copy to Path1       - TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path1/file1.txt
2025/06/04 01:59:31 INFO  : - Path2    Do queued copies to                - Path1
2025/06/04 01:59:31 INFO  : file1.txt: Updated modification time in destination
2025/06/04 01:59:31 INFO  : - Path1    Do queued copies to                - Path2
2025/06/04 01:59:31 INFO  : newfolder/éééö.txt: Updated modification time in destination
2025/06/04 01:59:31 INFO  : newfolder/HeLlO,wOrLd!.txt: Updated modification time in destination
2025/06/04 01:59:31 INFO  : 測試_Руский___ě_áñ👸🏼🧝🏾‍♀️💆🏿‍♂️🐨🤙🏼🤮🧑🏻‍🔧🧑‍🔬éö/測試_Руский___ě_áñ👸🏼🧝🏾‍♀️💆🏿‍♂️🐨🤙🏼🤮🧑🏻‍🔧🧑‍🔬éö.txt: Updated modification time in destination
2025/06/04 01:59:31 INFO  : Updating listings
2025/06/04 01:59:31 INFO  : Validating listings for Path1 "TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path1/" vs Path2 "TestPutio:rclone-test-cubobeq2foba/015654pa/normalization/path2/"
2025/06/04 01:59:31 INFO  : Bisync successful
2025/06/04 01:59:31 NOTICE: ----------------------------------------------------------
2025/06/04 01:59:31 NOTICE: | MISCOMPARE  -Golden vs +Results for  test.log
2025/06/04 01:59:31 NOTICE: | @@ -48,0 +49 @@
2025/06/04 01:59:31 NOTICE: | +INFO  : - Path2    File is new               - folder/hello,WORLD!.txt
2025/06/04 01:59:31 NOTICE: | @@ -50 +50,0 @@
2025/06/04 01:59:31 NOTICE: | -INFO  : - Path2    File is new               - folder/hello,WORLD!.txt
2025/06/04 01:59:31 NOTICE: | @@ -61 +61,2 @@
2025/06/04 01:59:31 NOTICE: | -INFO  : folder/éééö.txt: Files are equal but will copy anyway to fix case to folder/éééö.txt
2025/06/04 01:59:31 NOTICE: | +INFO  : folder/éééö.txt: Files are equal but will copy anyway to update modtime (will not rename)
2025/06/04 01:59:31 NOTICE: | +INFO  : - Path2    Queue copy to Path1       - {path1/}folder/éééö.txt
2025/06/04 01:59:31 NOTICE: | @@ -67 +67,0 @@
2025/06/04 01:59:31 NOTICE: | -INFO  : folder/éééö.txt: Fixed case by renaming to: folder/éééö.txt
2025/06/04 01:59:31 NOTICE: | @@ -120,0 +121 @@
2025/06/04 01:59:31 NOTICE: | +INFO  : - Path2    File is new               - newfolder/hello,WORLD!.txt
2025/06/04 01:59:31 NOTICE: | @@ -122 +122,0 @@
2025/06/04 01:59:31 NOTICE: | -INFO  : - Path2    File is new               - newfolder/hello,WORLD!.txt
2025/06/04 01:59:31 NOTICE: ----------------------------------------------------------
    bisync_test.go:560: TEST normalization FAILED - 1 MISCOMPARED FILES
--- FAIL: TestBisyncRemoteRemote (157.81s)
    --- FAIL: TestBisyncRemoteRemote/check_access_filters (28.11s)
    --- PASS: TestBisyncRemoteRemote/concurrent (15.08s)
    --- FAIL: TestBisyncRemoteRemote/filters (22.29s)
    --- PASS: TestBisyncRemoteRemote/nomodtime (24.78s)
    --- FAIL: TestBisyncRemoteRemote/normalization (67.10s)
FAIL
2025/06/04 01:59:32 NOTICE: purge failed: Rmdir: directory not found
"./bisync.test -test.v -test.timeout 2h0m0s -remote TestPutio: -verbose -test.run '^TestBisyncLocalRemote$/^(backupdir|changes|max_delete_path2_force)$|^TestBisyncRemoteLocal$/^(nomodtime|resync)$|^TestBisyncRemoteRemote$/^(check_access_filters|concurrent|filters|nomodtime|normalization)$'" - Finished ERROR in 3m50.64895049s (try 4/5): exit status 1: Failed [TestBisyncRemoteLocal/resync TestBisyncLocalRemote/changes TestBisyncLocalRemote/max_delete_path2_force TestBisyncRemoteRemote/check_access_filters TestBisyncRemoteRemote/filters TestBisyncRemoteRemote/normalization]