"./sync.test -test.v -test.timeout 1h0m0s -remote TestFilesCom: -verbose -test.run '^(TestCopyAfterDelete|TestFixCase|TestServerSideCopy|TestSyncBackupDirSuffixOnly|TestSyncEmptyDirectories|TestSyncNoEmptyDirectories|TestSyncNoTraverse|TestSyncNoUpdateDirModtime|TestSyncReplaceDirModTimeWithEmptyDirs|TestSyncSetDelayedModTimes)$|^TestTransform$/^ISO-8859-1$'" - Starting (try 2/5)
2026/07/26 04:45:59 DEBUG : Creating backend with remote "TestFilesCom:rclone-test-pojagiv1lila"
2026/07/26 04:45:59 DEBUG : Using config file from "/home/rclone/.rclone.conf"
2026/07/26 04:45:59 DEBUG : Creating backend with remote "/tmp/rclone3579479973"
=== RUN   TestSyncNoTraverse
    run.go:198: Remote "files root 'rclone-test-pojagiv1lila'", Local "Local file system at /tmp/rclone3579479973", Modify Window "1s"
2026/07/26 04:45:59 ERROR : Ignoring --no-traverse with sync
2026/07/26 04:46:00 DEBUG : Added delayed dir = "sub dir", newDst=<nil>
2026/07/26 04:46:00 DEBUG : sub dir/hello world: Need to transfer - File not found at Destination
2026/07/26 04:46:00 DEBUG : files root 'rclone-test-pojagiv1lila': Waiting for checks to finish
2026/07/26 04:46:00 DEBUG : files root 'rclone-test-pojagiv1lila': Waiting for transfers to finish
2026/07/26 04:46:01 DEBUG : sub dir/hello world: size = 11 OK
2026/07/26 04:46:01 DEBUG : sub dir/hello world: md5 = 5eb63bbbe01eeed093cb22bb8f5acdc3 OK
2026/07/26 04:46:01 INFO  : sub dir/hello world: Copied (new)
2026/07/26 04:46:01 DEBUG : Waiting for deletions to finish
2026/07/26 04:46:02 INFO  : sub dir: Set directory modification time (using DirSetModTime)
--- PASS: TestSyncNoTraverse (3.19s)
=== RUN   TestSyncNoUpdateDirModtime
    run.go:198: Remote "files root 'rclone-test-pojagiv1lila'", Local "Local file system at /tmp/rclone3579479973", Modify Window "1s"
2026/07/26 04:46:03 DEBUG : sub dir no update dir modtime: Making directory with metadata
2026/07/26 04:46:03 INFO  : sub dir no update dir modtime: Made directory with metadata (mtime=2001-02-03T04:05:06.499999999Z)
2026/07/26 04:46:03 DEBUG : files root 'rclone-test-pojagiv1lila': Waiting for checks to finish
2026/07/26 04:46:03 DEBUG : files root 'rclone-test-pojagiv1lila': Waiting for transfers to finish
2026/07/26 04:46:03 DEBUG : Waiting for deletions to finish
--- PASS: TestSyncNoUpdateDirModtime (1.56s)
=== RUN   TestSyncEmptyDirectories
    run.go:198: Remote "files root 'rclone-test-pojagiv1lila'", Local "Local file system at /tmp/rclone3579479973", Modify Window "1s"
2026/07/26 04:46:04 DEBUG : sub dir2: Making directory with metadata
2026/07/26 04:46:04 INFO  : sub dir2: Made directory with metadata (mtime=2011-12-25T12:59:59.123456789Z)
2026/07/26 04:46:04 INFO  : sub dir: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:04 INFO  : sub dir2: Making directory
2026/07/26 04:46:05 INFO  : sub dir2: Made directory with modification time 2011-12-25 12:59:59.123456789 +0000 UTC
2026/07/26 04:46:05 DEBUG : Added delayed dir = "sub dir2", newDst=<nil>
2026/07/26 04:46:05 INFO  : sub dir: Making directory
2026/07/26 04:46:05 INFO  : sub dir: Made directory with modification time 2001-02-03 04:05:06.499999999 +0000 UTC
2026/07/26 04:46:05 DEBUG : Added delayed dir = "sub dir", newDst=<nil>
2026/07/26 04:46:05 DEBUG : sub dir/hello world: Need to transfer - File not found at Destination
2026/07/26 04:46:05 DEBUG : files root 'rclone-test-pojagiv1lila': Waiting for checks to finish
2026/07/26 04:46:05 DEBUG : files root 'rclone-test-pojagiv1lila': Waiting for transfers to finish
2026/07/26 04:46:06 DEBUG : sub dir/hello world: size = 11 OK
2026/07/26 04:46:06 DEBUG : sub dir/hello world: md5 = 5eb63bbbe01eeed093cb22bb8f5acdc3 OK
2026/07/26 04:46:06 INFO  : sub dir/hello world: Copied (new)
2026/07/26 04:46:06 DEBUG : Waiting for deletions to finish
2026/07/26 04:46:06 INFO  : sub dir2: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:06 INFO  : sub dir: Set directory modification time (using DirSetModTime)
--- PASS: TestSyncEmptyDirectories (3.47s)
=== RUN   TestSyncSetDelayedModTimes
    run.go:198: Remote "files root 'rclone-test-pojagiv1lila'", Local "Local file system at /tmp/rclone3579479973", Modify Window "1s"
2026/07/26 04:46:08 INFO  : a1/b2/c1/d1/e1/f1: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:08 INFO  : a1/b2/c1/d1/e1: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:08 INFO  : a1/b2/c1/d1: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:08 INFO  : a1/b2/c1: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:08 INFO  : a1/b2: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:08 INFO  : a1/b1/c1/d2/e1/f2: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:08 INFO  : a1/b1/c1/d2/e1/f1: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:08 INFO  : a1/b1/c1/d2/e1: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:08 INFO  : a1/b1/c1/d2: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:08 INFO  : a1/b1/c1/d1/e1/f1: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:08 INFO  : a1/b1/c1/d1/e1: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:08 INFO  : a1/b1/c1/d1: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:08 INFO  : a1/b1/c1: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:08 INFO  : a1/b1: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:08 INFO  : a1: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:08 INFO  : a1: Making directory
2026/07/26 04:46:08 INFO  : a1: Made directory with modification time 2001-02-03 04:19:06.499999999 +0000 UTC
2026/07/26 04:46:08 DEBUG : Added delayed dir = "a1", newDst=<nil>
2026/07/26 04:46:08 INFO  : a1/b1: Making directory
2026/07/26 04:46:08 INFO  : a1/b1: Made directory with modification time 2001-02-03 04:18:06.499999999 +0000 UTC
2026/07/26 04:46:08 DEBUG : Added delayed dir = "a1/b1", newDst=<nil>
2026/07/26 04:46:08 INFO  : a1/b2: Making directory
2026/07/26 04:46:09 INFO  : a1/b2: Made directory with modification time 2001-02-03 04:09:06.499999999 +0000 UTC
2026/07/26 04:46:09 DEBUG : Added delayed dir = "a1/b2", newDst=<nil>
2026/07/26 04:46:09 INFO  : a1/b2/c1: Making directory
2026/07/26 04:46:09 INFO  : a1/b1/c1: Making directory
2026/07/26 04:46:09 INFO  : a1/b2/c1: Made directory with modification time 2001-02-03 04:08:06.499999999 +0000 UTC
2026/07/26 04:46:09 DEBUG : Added delayed dir = "a1/b2/c1", newDst=<nil>
2026/07/26 04:46:09 INFO  : a1/b2/c1/d1: Making directory
2026/07/26 04:46:09 INFO  : a1/b1/c1: Made directory with modification time 2001-02-03 04:17:06.499999999 +0000 UTC
2026/07/26 04:46:09 DEBUG : Added delayed dir = "a1/b1/c1", newDst=<nil>
2026/07/26 04:46:09 INFO  : a1/b1/c1/d1: Making directory
2026/07/26 04:46:09 INFO  : a1/b2/c1/d1: Made directory with modification time 2001-02-03 04:07:06.499999999 +0000 UTC
2026/07/26 04:46:09 DEBUG : Added delayed dir = "a1/b2/c1/d1", newDst=<nil>
2026/07/26 04:46:09 INFO  : a1/b2/c1/d1/e1: Making directory
2026/07/26 04:46:09 INFO  : a1/b1/c1/d1: Made directory with modification time 2001-02-03 04:16:06.499999999 +0000 UTC
2026/07/26 04:46:09 DEBUG : Added delayed dir = "a1/b1/c1/d1", newDst=<nil>
2026/07/26 04:46:09 INFO  : a1/b1/c1/d2: Making directory
2026/07/26 04:46:10 INFO  : a1/b2/c1/d1/e1: Made directory with modification time 2001-02-03 04:06:06.499999999 +0000 UTC
2026/07/26 04:46:10 DEBUG : Added delayed dir = "a1/b2/c1/d1/e1", newDst=<nil>
2026/07/26 04:46:10 INFO  : a1/b2/c1/d1/e1/f1: Making directory
2026/07/26 04:46:10 INFO  : a1/b1/c1/d2: Made directory with modification time 2001-02-03 04:13:06.499999999 +0000 UTC
2026/07/26 04:46:10 DEBUG : Added delayed dir = "a1/b1/c1/d2", newDst=<nil>
2026/07/26 04:46:10 INFO  : a1/b1/c1/d2/e1: Making directory
2026/07/26 04:46:10 INFO  : a1/b1/c1/d1/e1: Making directory
2026/07/26 04:46:10 INFO  : a1/b2/c1/d1/e1/f1: Made directory with modification time 2001-02-03 04:05:06.499999999 +0000 UTC
2026/07/26 04:46:10 DEBUG : Added delayed dir = "a1/b2/c1/d1/e1/f1", newDst=<nil>
2026/07/26 04:46:10 INFO  : a1/b1/c1/d2/e1: Made directory with modification time 2001-02-03 04:12:06.499999999 +0000 UTC
2026/07/26 04:46:10 DEBUG : Added delayed dir = "a1/b1/c1/d2/e1", newDst=<nil>
2026/07/26 04:46:10 INFO  : a1/b1/c1/d2/e1/f1: Making directory
2026/07/26 04:46:10 INFO  : a1/b1/c1/d1/e1: Made directory with modification time 2001-02-03 04:15:06.499999999 +0000 UTC
2026/07/26 04:46:10 DEBUG : Added delayed dir = "a1/b1/c1/d1/e1", newDst=<nil>
2026/07/26 04:46:10 INFO  : a1/b1/c1/d1/e1/f1: Making directory
2026/07/26 04:46:10 INFO  : a1/b1/c1/d2/e1/f1: Made directory with modification time 2001-02-03 04:11:06.499999999 +0000 UTC
2026/07/26 04:46:10 DEBUG : Added delayed dir = "a1/b1/c1/d2/e1/f1", newDst=<nil>
2026/07/26 04:46:10 INFO  : a1/b1/c1/d2/e1/f2: Making directory
2026/07/26 04:46:10 INFO  : a1/b1/c1/d1/e1/f1: Made directory with modification time 2001-02-03 04:14:06.499999999 +0000 UTC
2026/07/26 04:46:10 DEBUG : Added delayed dir = "a1/b1/c1/d1/e1/f1", newDst=<nil>
2026/07/26 04:46:11 INFO  : a1/b1/c1/d2/e1/f2: Made directory with modification time 2001-02-03 04:10:06.499999999 +0000 UTC
2026/07/26 04:46:11 DEBUG : Added delayed dir = "a1/b1/c1/d2/e1/f2", newDst=<nil>
2026/07/26 04:46:11 DEBUG : files root 'rclone-test-pojagiv1lila': Waiting for checks to finish
2026/07/26 04:46:11 DEBUG : files root 'rclone-test-pojagiv1lila': Waiting for transfers to finish
2026/07/26 04:46:11 DEBUG : Waiting for deletions to finish
2026/07/26 04:46:11 INFO  : a1/b1/c1/d2/e1/f1: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:11 INFO  : a1/b1/c1/d1/e1/f1: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:11 INFO  : a1/b2/c1/d1/e1/f1: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:11 INFO  : a1/b1/c1/d2/e1/f2: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:11 INFO  : a1/b2/c1/d1/e1: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:11 INFO  : a1/b1/c1/d1/e1: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:11 INFO  : a1/b1/c1/d2/e1: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:11 INFO  : a1/b1/c1/d2: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:11 INFO  : a1/b2/c1/d1: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:11 INFO  : a1/b1/c1/d1: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:11 INFO  : a1/b1/c1: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:11 INFO  : a1/b2/c1: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:12 INFO  : a1/b2: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:12 INFO  : a1/b1: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:12 INFO  : a1: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:16 DEBUG : pacer: low level retry 1/10 (error Folder Not Empty - `Folder rclone-test-pojagiv1lila/a1/b2/c1/d1/e1 not empty`)
2026/07/26 04:46:16 DEBUG : pacer: Rate limited, increasing sleep to 20ms
2026/07/26 04:46:16 DEBUG : pacer: Reducing sleep to 15ms
2026/07/26 04:46:16 DEBUG : pacer: low level retry 1/10 (error Folder Not Empty - `Folder rclone-test-pojagiv1lila/a1/b2/c1/d1 not empty`)
2026/07/26 04:46:16 DEBUG : pacer: Rate limited, increasing sleep to 30ms
2026/07/26 04:46:16 DEBUG : pacer: Reducing sleep to 22.5ms
2026/07/26 04:46:16 DEBUG : pacer: low level retry 1/10 (error Folder Not Empty - `Folder rclone-test-pojagiv1lila/a1/b2/c1 not empty`)
2026/07/26 04:46:16 DEBUG : pacer: Rate limited, increasing sleep to 45ms
2026/07/26 04:46:17 DEBUG : pacer: Reducing sleep to 33.75ms
2026/07/26 04:46:17 DEBUG : pacer: low level retry 1/10 (error Folder Not Empty - `Folder rclone-test-pojagiv1lila/a1/b2 not empty`)
2026/07/26 04:46:17 DEBUG : pacer: Rate limited, increasing sleep to 67.5ms
2026/07/26 04:46:17 DEBUG : pacer: Reducing sleep to 50.625ms
2026/07/26 04:46:17 DEBUG : pacer: Reducing sleep to 37.96875ms
2026/07/26 04:46:17 DEBUG : pacer: Reducing sleep to 28.476562ms
2026/07/26 04:46:17 DEBUG : pacer: low level retry 1/10 (error Folder Not Empty - `Folder rclone-test-pojagiv1lila/a1/b1/c1/d2/e1 not empty`)
2026/07/26 04:46:17 DEBUG : pacer: Rate limited, increasing sleep to 56.953124ms
2026/07/26 04:46:18 DEBUG : pacer: Reducing sleep to 42.714843ms
2026/07/26 04:46:18 DEBUG : pacer: Reducing sleep to 32.036132ms
2026/07/26 04:46:18 DEBUG : pacer: Reducing sleep to 24.027099ms
2026/07/26 04:46:18 DEBUG : pacer: low level retry 1/10 (error Folder Not Empty - `Folder rclone-test-pojagiv1lila/a1/b1/c1/d1/e1 not empty`)
2026/07/26 04:46:18 DEBUG : pacer: Rate limited, increasing sleep to 48.054198ms
2026/07/26 04:46:18 DEBUG : pacer: low level retry 2/10 (error Folder Not Empty - `Folder rclone-test-pojagiv1lila/a1/b1/c1/d1/e1 not empty`)
2026/07/26 04:46:18 DEBUG : pacer: Rate limited, increasing sleep to 96.108396ms
2026/07/26 04:46:18 DEBUG : pacer: Reducing sleep to 72.081297ms
2026/07/26 04:46:19 DEBUG : pacer: Reducing sleep to 54.060972ms
2026/07/26 04:46:19 DEBUG : pacer: low level retry 1/10 (error Folder Not Empty - `Folder rclone-test-pojagiv1lila/a1/b1/c1 not empty`)
2026/07/26 04:46:19 DEBUG : pacer: Rate limited, increasing sleep to 108.121944ms
2026/07/26 04:46:19 DEBUG : pacer: Reducing sleep to 81.091458ms
2026/07/26 04:46:19 DEBUG : pacer: low level retry 1/10 (error Folder Not Empty - `Folder rclone-test-pojagiv1lila/a1/b1 not empty`)
2026/07/26 04:46:19 DEBUG : pacer: Rate limited, increasing sleep to 162.182916ms
2026/07/26 04:46:19 DEBUG : pacer: low level retry 2/10 (error Folder Not Empty - `Folder rclone-test-pojagiv1lila/a1/b1 not empty`)
2026/07/26 04:46:19 DEBUG : pacer: Rate limited, increasing sleep to 324.365832ms
2026/07/26 04:46:19 DEBUG : pacer: low level retry 3/10 (error Folder Not Empty - `Folder rclone-test-pojagiv1lila/a1/b1 not empty`)
2026/07/26 04:46:19 DEBUG : pacer: Rate limited, increasing sleep to 648.731664ms
2026/07/26 04:46:20 DEBUG : pacer: Reducing sleep to 486.548748ms
2026/07/26 04:46:20 DEBUG : pacer: Reducing sleep to 364.911561ms
2026/07/26 04:46:21 DEBUG : pacer: Reducing sleep to 273.68367ms
--- PASS: TestSyncSetDelayedModTimes (13.16s)
=== RUN   TestSyncNoEmptyDirectories
    run.go:198: Remote "files root 'rclone-test-pojagiv1lila'", Local "Local file system at /tmp/rclone3579479973", Modify Window "1s"
2026/07/26 04:46:21 INFO  : sub dir2: Making directory
2026/07/26 04:46:21 DEBUG : pacer: Reducing sleep to 205.262752ms
2026/07/26 04:46:21 DEBUG : Added delayed dir = "sub dir2", newDst=<nil>
2026/07/26 04:46:21 DEBUG : Added delayed dir = "sub dir", newDst=<nil>
2026/07/26 04:46:21 DEBUG : sub dir/hello world: Need to transfer - File not found at Destination
2026/07/26 04:46:21 DEBUG : files root 'rclone-test-pojagiv1lila': Waiting for checks to finish
2026/07/26 04:46:21 DEBUG : files root 'rclone-test-pojagiv1lila': Waiting for transfers to finish
2026/07/26 04:46:22 DEBUG : pacer: Reducing sleep to 153.947064ms
2026/07/26 04:46:22 DEBUG : pacer: Reducing sleep to 115.460298ms
2026/07/26 04:46:23 DEBUG : pacer: Reducing sleep to 86.595223ms
2026/07/26 04:46:23 DEBUG : sub dir/hello world: size = 11 OK
2026/07/26 04:46:23 DEBUG : sub dir/hello world: md5 = 5eb63bbbe01eeed093cb22bb8f5acdc3 OK
2026/07/26 04:46:23 INFO  : sub dir/hello world: Copied (new)
2026/07/26 04:46:23 DEBUG : Waiting for deletions to finish
2026/07/26 04:46:23 DEBUG : pacer: Reducing sleep to 64.946417ms
2026/07/26 04:46:23 INFO  : sub dir: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:23 DEBUG : pacer: Reducing sleep to 48.709812ms
2026/07/26 04:46:23 DEBUG : pacer: Reducing sleep to 36.532359ms
2026/07/26 04:46:23 DEBUG : pacer: Reducing sleep to 27.399269ms
2026/07/26 04:46:23 DEBUG : pacer: Reducing sleep to 20.549451ms
2026/07/26 04:46:23 DEBUG : pacer: Reducing sleep to 15.412088ms
2026/07/26 04:46:23 DEBUG : pacer: Reducing sleep to 11.559066ms
2026/07/26 04:46:23 DEBUG : pacer: Reducing sleep to 10ms
--- PASS: TestSyncNoEmptyDirectories (2.90s)
=== RUN   TestServerSideCopy
    run.go:198: Remote "files root 'rclone-test-pojagiv1lila'", Local "Local file system at /tmp/rclone3579479973", Modify Window "1s"
2026/07/26 04:46:25 DEBUG : Creating backend with remote "TestFilesCom:rclone-test-tupujef5zeyu"
    sync_test.go:620: Server side copy (if possible) files root 'rclone-test-pojagiv1lila' -> files root 'rclone-test-tupujef5zeyu'
2026/07/26 04:46:26 DEBUG : Added delayed dir = "sub dir", newDst=<nil>
2026/07/26 04:46:26 DEBUG : sub dir/hello world: Need to transfer - File not found at Destination
2026/07/26 04:46:26 DEBUG : files root 'rclone-test-tupujef5zeyu': Waiting for checks to finish
2026/07/26 04:46:26 DEBUG : files root 'rclone-test-tupujef5zeyu': Waiting for transfers to finish
2026/07/26 04:46:28 DEBUG : sub dir/hello world: size = 11 OK
2026/07/26 04:46:28 DEBUG : sub dir/hello world: md5 = 5eb63bbbe01eeed093cb22bb8f5acdc3 OK
2026/07/26 04:46:28 INFO  : sub dir/hello world: Copied (server-side copy)
2026/07/26 04:46:28 INFO  : sub dir: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:28 DEBUG : files root 'rclone-test-tupujef5zeyu': Purge remote
--- PASS: TestServerSideCopy (5.20s)
=== RUN   TestCopyAfterDelete
    run.go:198: Remote "files root 'rclone-test-pojagiv1lila'", Local "Local file system at /tmp/rclone3579479973", Modify Window "1s"
2026/07/26 04:46:30 ERROR : error listing: directory not found
2026/07/26 04:46:30 INFO  : Local file system at /tmp/rclone3579479973: Making directory
2026/07/26 04:46:30 DEBUG : files root 'rclone-test-pojagiv1lila': Waiting for checks to finish
2026/07/26 04:46:30 DEBUG : files root 'rclone-test-pojagiv1lila': Waiting for transfers to finish
--- PASS: TestCopyAfterDelete (2.63s)
=== RUN   TestSyncBackupDirSuffixOnly
    run.go:198: Remote "files root 'rclone-test-pojagiv1lila'", Local "Local file system at /tmp/rclone3579479973", Modify Window "1s"
2026/07/26 04:46:35 DEBUG : Creating backend with remote "TestFilesCom:rclone-test-pojagiv1lila/dst"
2026/07/26 04:46:36 DEBUG : one: size = 4 (Local file system at /tmp/rclone3579479973)
2026/07/26 04:46:36 DEBUG : one: size = 3 (files root 'rclone-test-pojagiv1lila/dst')
2026/07/26 04:46:36 DEBUG : one: Sizes differ
2026/07/26 04:46:36 DEBUG : files root 'rclone-test-pojagiv1lila/dst': Waiting for checks to finish
2026/07/26 04:46:36 DEBUG : two: size = 3 OK
2026/07/26 04:46:36 DEBUG : two: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:46:36 DEBUG : two: Unchanged skipping
2026/07/26 04:46:38 INFO  : one: Moved (server-side) to: one.bak
2026/07/26 04:46:38 DEBUG : files root 'rclone-test-pojagiv1lila/dst': Waiting for transfers to finish
2026/07/26 04:46:39 DEBUG : one: size = 4 OK
2026/07/26 04:46:39 DEBUG : one: md5 = c7957179c41f69d44f217a108c7915d8 OK
2026/07/26 04:46:39 INFO  : one: Copied (new)
2026/07/26 04:46:39 DEBUG : Waiting for deletions to finish
2026/07/26 04:46:40 INFO  : three.txt: Moved (server-side) to: three.txt.bak
2026/07/26 04:46:40 INFO  : three.txt: Moved into backup dir
2026/07/26 04:46:42 DEBUG : one.bak: Excluded (Path Filter)
2026/07/26 04:46:42 DEBUG : one.bak: Excluded
2026/07/26 04:46:42 DEBUG : three.txt.bak: Excluded (Path Filter)
2026/07/26 04:46:42 DEBUG : three.txt.bak: Excluded
2026/07/26 04:46:42 DEBUG : files root 'rclone-test-pojagiv1lila/dst': Waiting for checks to finish
2026/07/26 04:46:42 DEBUG : one: size = 5 (Local file system at /tmp/rclone3579479973)
2026/07/26 04:46:42 DEBUG : one: size = 4 (files root 'rclone-test-pojagiv1lila/dst')
2026/07/26 04:46:42 DEBUG : one: Sizes differ
2026/07/26 04:46:42 DEBUG : two: size = 3 OK
2026/07/26 04:46:42 DEBUG : two: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:46:42 DEBUG : two: Unchanged skipping
2026/07/26 04:46:42 INFO  : one.bak: Deleted
2026/07/26 04:46:43 INFO  : one: Moved (server-side) to: one.bak
2026/07/26 04:46:43 DEBUG : files root 'rclone-test-pojagiv1lila/dst': Waiting for transfers to finish
2026/07/26 04:46:44 DEBUG : one: size = 5 OK
2026/07/26 04:46:44 DEBUG : one: md5 = 0f93e81041f0cab37c37a05ae998b219 OK
2026/07/26 04:46:44 INFO  : one: Copied (new)
2026/07/26 04:46:44 DEBUG : Waiting for deletions to finish
2026/07/26 04:46:44 INFO  : three.txt.bak: Deleted
2026/07/26 04:46:45 INFO  : three.txt: Moved (server-side) to: three.txt.bak
2026/07/26 04:46:45 INFO  : three.txt: Moved into backup dir
--- PASS: TestSyncBackupDirSuffixOnly (14.68s)
=== RUN   TestFixCase
    run.go:198: Remote "files root 'rclone-test-pojagiv1lila'", Local "Local file system at /tmp/rclone3579479973", Modify Window "1s"
2026/07/26 04:46:51 DEBUG : EXISTING: size = 6 OK
2026/07/26 04:46:51 DEBUG : existingbutdifferent: size = 5 (Local file system at /tmp/rclone3579479973)
2026/07/26 04:46:51 DEBUG : existing: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:46:51 DEBUG : EXISTINGBUTDIFFERENT: size = 8 (files root 'rclone-test-pojagiv1lila')
2026/07/26 04:46:51 DEBUG : existing: Unchanged skipping
2026/07/26 04:46:51 DEBUG : existingbutdifferent: Sizes differ
2026/07/26 04:46:52 INFO  : SUBDIRA: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:52 DEBUG : Added delayed dir = "SUBDIRA", newDst=SUBDIRA
2026/07/26 04:46:52 DEBUG : EXISTING: moving to existing-rclone-move-yobujex1
2026/07/26 04:46:52 DEBUG : EXISTINGBUTDIFFERENT: moving to existingbutdifferent-rclone-move-mokuhat6
2026/07/26 04:46:52 INFO  : EXISTING: Moved (server-side) to: existing-rclone-move-yobujex1
2026/07/26 04:46:52 DEBUG : EXISTING: moving to existing
2026/07/26 04:46:52 INFO  : EXISTINGBUTDIFFERENT: Moved (server-side) to: existingbutdifferent-rclone-move-mokuhat6
2026/07/26 04:46:52 DEBUG : EXISTINGBUTDIFFERENT: moving to existingbutdifferent
2026/07/26 04:46:52 INFO  : existing-rclone-move-yobujex1: Moved (server-side) to: existing
2026/07/26 04:46:52 INFO  : EXISTING: Moved (server-side) to: existing
2026/07/26 04:46:52 INFO  : EXISTING: Fixed case by renaming to: existing
2026/07/26 04:46:53 INFO  : existingbutdifferent-rclone-move-mokuhat6: Moved (server-side) to: existingbutdifferent
2026/07/26 04:46:53 INFO  : EXISTINGBUTDIFFERENT: Moved (server-side) to: existingbutdifferent
2026/07/26 04:46:53 INFO  : EXISTINGBUTDIFFERENT: Fixed case by renaming to: existingbutdifferent
2026/07/26 04:46:53 INFO  : SUBDIRA: Fixed case by renaming to: subdira
2026/07/26 04:46:53 INFO  : SUBDIRA/subdirb: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:53 DEBUG : Added delayed dir = "SUBDIRA/subdirb", newDst=SUBDIRA/subdirb
2026/07/26 04:46:53 DEBUG : existingbutdifferent: size = 5 OK
2026/07/26 04:46:53 DEBUG : existingbutdifferent: md5 = 81bdd90fd4bc5a1c9b7b603014ff1388 OK
2026/07/26 04:46:53 INFO  : existingbutdifferent: Copied (replaced existing)
2026/07/26 04:46:54 INFO  : SUBDIRA/subdirb: Fixed case by renaming to: subdira/subdirb
2026/07/26 04:46:55 INFO  : SUBDIRA/subdirb/SUBDIRC: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:55 DEBUG : Added delayed dir = "SUBDIRA/subdirb/SUBDIRC", newDst=SUBDIRA/subdirb/SUBDIRC
2026/07/26 04:46:56 INFO  : SUBDIRA/subdirb/SUBDIRC: Fixed case by renaming to: subdira/subdirb/subdirc
2026/07/26 04:46:56 DEBUG : subdira/subdirb/subdirc/hello: size = 5 (Local file system at /tmp/rclone3579479973)
2026/07/26 04:46:56 DEBUG : SUBDIRA/subdirb/SUBDIRC/HELLO: size = 8 (files root 'rclone-test-pojagiv1lila')
2026/07/26 04:46:56 DEBUG : subdira/subdirb/subdirc/hello: Sizes differ
2026/07/26 04:46:56 INFO  : SUBDIRA/subdirb/SUBDIRC/subdird: Set directory modification time (using DirSetModTime)
2026/07/26 04:46:56 DEBUG : Added delayed dir = "SUBDIRA/subdirb/SUBDIRC/subdird", newDst=SUBDIRA/subdirb/SUBDIRC/subdird
2026/07/26 04:46:56 DEBUG : SUBDIRA/subdirb/SUBDIRC/HELLO: moving to subdira/subdirb/subdirc/hello-rclone-move-yulugij5
2026/07/26 04:46:57 INFO  : SUBDIRA/subdirb/SUBDIRC/HELLO: Moved (server-side) to: subdira/subdirb/subdirc/hello-rclone-move-yulugij5
2026/07/26 04:46:57 DEBUG : SUBDIRA/subdirb/SUBDIRC/HELLO: moving to subdira/subdirb/subdirc/hello
2026/07/26 04:46:57 INFO  : subdira/subdirb/subdirc/hello-rclone-move-yulugij5: Moved (server-side) to: subdira/subdirb/subdirc/hello
2026/07/26 04:46:57 INFO  : SUBDIRA/subdirb/SUBDIRC/HELLO: Moved (server-side) to: subdira/subdirb/subdirc/hello
2026/07/26 04:46:57 INFO  : SUBDIRA/subdirb/SUBDIRC/HELLO: Fixed case by renaming to: subdira/subdirb/subdirc/hello
2026/07/26 04:46:57 INFO  : SUBDIRA/subdirb/SUBDIRC/subdird: Fixed case by renaming to: subdira/subdirb/subdirc/subdird
2026/07/26 04:46:57 DEBUG : files root 'rclone-test-pojagiv1lila': Waiting for checks to finish
2026/07/26 04:46:57 DEBUG : subdira/subdirb/subdirc/subdird/filewithoutcasedifferences: size = 5 (Local file system at /tmp/rclone3579479973)
2026/07/26 04:46:57 DEBUG : SUBDIRA/subdirb/SUBDIRC/subdird/filewithoutcasedifferences: size = 8 (files root 'rclone-test-pojagiv1lila')
2026/07/26 04:46:57 DEBUG : subdira/subdirb/subdirc/subdird/filewithoutcasedifferences: Sizes differ
2026/07/26 04:46:58 DEBUG : SUBDIRA/subdirb/SUBDIRC/subdird/filewithoutcasedifferences: moving to subdira/subdirb/subdirc/subdird/filewithoutcasedifferences-rclone-move-napeloq8
2026/07/26 04:46:58 INFO  : SUBDIRA/subdirb/SUBDIRC/subdird/filewithoutcasedifferences: Moved (server-side) to: subdira/subdirb/subdirc/subdird/filewithoutcasedifferences-rclone-move-napeloq8
2026/07/26 04:46:58 DEBUG : SUBDIRA/subdirb/SUBDIRC/subdird/filewithoutcasedifferences: moving to subdira/subdirb/subdirc/subdird/filewithoutcasedifferences
2026/07/26 04:46:58 DEBUG : subdira/subdirb/subdirc/hello: size = 5 OK
2026/07/26 04:46:58 DEBUG : subdira/subdirb/subdirc/hello: md5 = 81bdd90fd4bc5a1c9b7b603014ff1388 OK
2026/07/26 04:46:58 INFO  : subdira/subdirb/subdirc/hello: Copied (replaced existing)
2026/07/26 04:46:59 INFO  : subdira/subdirb/subdirc/subdird/filewithoutcasedifferences-rclone-move-napeloq8: Moved (server-side) to: subdira/subdirb/subdirc/subdird/filewithoutcasedifferences
2026/07/26 04:46:59 INFO  : SUBDIRA/subdirb/SUBDIRC/subdird/filewithoutcasedifferences: Moved (server-side) to: subdira/subdirb/subdirc/subdird/filewithoutcasedifferences
2026/07/26 04:46:59 INFO  : SUBDIRA/subdirb/SUBDIRC/subdird/filewithoutcasedifferences: Fixed case by renaming to: subdira/subdirb/subdirc/subdird/filewithoutcasedifferences
2026/07/26 04:46:59 DEBUG : files root 'rclone-test-pojagiv1lila': Waiting for transfers to finish
2026/07/26 04:47:00 DEBUG : subdira/subdirb/subdirc/subdird/filewithoutcasedifferences: size = 5 OK
2026/07/26 04:47:00 DEBUG : subdira/subdirb/subdirc/subdird/filewithoutcasedifferences: md5 = 81bdd90fd4bc5a1c9b7b603014ff1388 OK
2026/07/26 04:47:00 INFO  : subdira/subdirb/subdirc/subdird/filewithoutcasedifferences: Copied (replaced existing)
2026/07/26 04:47:00 DEBUG : Waiting for deletions to finish
2026/07/26 04:47:02 DEBUG : pacer: low level retry 1/10 (error Folder Not Empty - `Folder rclone-test-pojagiv1lila/subdira/subdirb not empty`)
2026/07/26 04:47:02 DEBUG : pacer: Rate limited, increasing sleep to 20ms
2026/07/26 04:47:02 DEBUG : pacer: Reducing sleep to 15ms
2026/07/26 04:47:03 DEBUG : pacer: low level retry 1/10 (error Folder Not Empty - `Folder rclone-test-pojagiv1lila/subdira not empty`)
2026/07/26 04:47:03 DEBUG : pacer: Rate limited, increasing sleep to 30ms
2026/07/26 04:47:03 DEBUG : pacer: low level retry 2/10 (error Folder Not Empty - `Folder rclone-test-pojagiv1lila/subdira not empty`)
2026/07/26 04:47:03 DEBUG : pacer: Rate limited, increasing sleep to 60ms
2026/07/26 04:47:03 DEBUG : pacer: low level retry 3/10 (error Folder Not Empty - `Folder rclone-test-pojagiv1lila/subdira not empty`)
2026/07/26 04:47:03 DEBUG : pacer: Rate limited, increasing sleep to 120ms
2026/07/26 04:47:03 DEBUG : pacer: low level retry 4/10 (error Folder Not Empty - `Folder rclone-test-pojagiv1lila/subdira not empty`)
2026/07/26 04:47:03 DEBUG : pacer: Rate limited, increasing sleep to 240ms
2026/07/26 04:47:03 DEBUG : pacer: Reducing sleep to 180ms
2026/07/26 04:47:03 DEBUG : pacer: Reducing sleep to 135ms
--- PASS: TestFixCase (17.13s)
=== RUN   TestSyncReplaceDirModTimeWithEmptyDirs
    run.go:198: Remote "files root 'rclone-test-pojagiv1lila'", Local "Local file system at /tmp/rclone3579479973", Modify Window "1s"
2026/07/26 04:47:03 DEBUG : empty_dir: Making directory with metadata
2026/07/26 04:47:03 INFO  : empty_dir: Made directory with metadata (mtime=2011-12-25T12:59:59.123456789Z)
2026/07/26 04:47:03 DEBUG : empty_on_remote: Making directory with metadata
2026/07/26 04:47:03 INFO  : empty_on_remote: Made directory with metadata (mtime=2011-12-25T12:59:59.123456789Z)
2026/07/26 04:47:03 INFO  : empty_on_remote: Making directory
2026/07/26 04:47:04 DEBUG : pacer: Reducing sleep to 101.25ms
2026/07/26 04:47:04 DEBUG : pacer: Reducing sleep to 75.9375ms
2026/07/26 04:47:04 INFO  : empty_on_remote: Made directory with modification time 2011-12-25 12:59:59.123456789 +0000 UTC
2026/07/26 04:47:06 INFO  : test_dir1: Set directory modification time (using DirSetModTime)
2026/07/26 04:47:06 INFO  : test_dir2: Set directory modification time (using DirSetModTime)
2026/07/26 04:47:06 INFO  : test_dir2/sub_dir: Set directory modification time (using DirSetModTime)
2026/07/26 04:47:06 INFO  : empty_on_remote: Set directory modification time (using DirSetModTime)
2026/07/26 04:47:06 INFO  : empty_dir: Set directory modification time (using DirSetModTime)
2026/07/26 04:47:10 DEBUG : pacer: low level retry 1/10 (error Folder Not Empty - `Folder rclone-test-pojagiv1lila/test_dir2 not empty`)
2026/07/26 04:47:10 DEBUG : pacer: Rate limited, increasing sleep to 20ms
2026/07/26 04:47:10 DEBUG : pacer: Reducing sleep to 15ms
2026/07/26 04:47:10 DEBUG : pacer: Reducing sleep to 11.25ms
2026/07/26 04:47:10 DEBUG : pacer: Reducing sleep to 10ms
--- PASS: TestSyncReplaceDirModTimeWithEmptyDirs (7.20s)
=== RUN   TestTransform
=== RUN   TestTransform/ISO-8859-1
    run.go:198: Remote "files root 'rclone-test-pojagiv1lila'", Local "Local file system at /tmp/rclone3579479973", Modify Window "1s"
2026/07/26 04:47:51 DEBUG : Waiting for deletions to finish
2026/07/26 04:47:51 DEBUG : apple: Excluded (Path Filter)
2026/07/26 04:47:51 DEBUG : apple: Excluded
2026/07/26 04:47:51 DEBUG : appleappleapplebanana: Excluded (Path Filter)
2026/07/26 04:47:51 DEBUG : appleappleapplebanana: Excluded
2026/07/26 04:47:51 DEBUG : banana: Excluded (Path Filter)
2026/07/26 04:47:51 DEBUG : banana: Excluded
2026/07/26 04:47:51 DEBUG : splitbananasplit: Excluded (Path Filter)
2026/07/26 04:47:51 DEBUG : splitbananasplit: Excluded
2026/07/26 04:47:52 DEBUG : dir1/0000-abcdefg.txt: Excluded (Path Filter)
2026/07/26 04:47:52 DEBUG : dir1/0000-abcdefg.txt: Excluded
2026/07/26 04:47:52 DEBUG : dir1/0001-bcdefgh.txt: Excluded (Path Filter)
2026/07/26 04:47:52 DEBUG : dir1/0001-bcdefgh.txt: Excluded
2026/07/26 04:47:52 DEBUG : dir1/0002-cdefghi.txt: Excluded (Path Filter)
2026/07/26 04:47:52 DEBUG : dir1/0002-cdefghi.txt: Excluded
2026/07/26 04:47:52 DEBUG : dir1/0003-defghij.txt: Excluded (Path Filter)
2026/07/26 04:47:52 DEBUG : dir1/0003-defghij.txt: Excluded
2026/07/26 04:47:52 DEBUG : dir1/0004-efghijk.txt: Excluded (Path Filter)
2026/07/26 04:47:52 DEBUG : dir1/0004-efghijk.txt: Excluded
2026/07/26 04:47:52 DEBUG : dir1/0005-fghijkl.txt: Excluded (Path Filter)
2026/07/26 04:47:52 DEBUG : dir1/0005-fghijkl.txt: Excluded
2026/07/26 04:47:52 DEBUG : dir1/0006-ghijklm.txt: Excluded (Path Filter)
2026/07/26 04:47:52 DEBUG : dir1/0006-ghijklm.txt: Excluded
2026/07/26 04:47:52 DEBUG : dir1/0007-1234567.txt: Excluded (Path Filter)
2026/07/26 04:47:52 DEBUG : dir1/0007-1234567.txt: Excluded
2026/07/26 04:47:52 DEBUG : dir1/0008-2345678.txt: Excluded (Path Filter)
2026/07/26 04:47:52 DEBUG : dir1/0008-2345678.txt: Excluded
2026/07/26 04:47:52 DEBUG : dir1/0009-3456789.txt: Excluded (Path Filter)
2026/07/26 04:47:52 DEBUG : dir1/0009-3456789.txt: Excluded
2026/07/26 04:47:52 DEBUG : dir1/0010-456789.txt: Excluded (Path Filter)
2026/07/26 04:47:52 DEBUG : dir1/0010-456789.txt: Excluded
2026/07/26 04:47:52 DEBUG : dir1/0011-56789;.txt: Excluded (Path Filter)
2026/07/26 04:47:52 DEBUG : dir1/0011-56789;.txt: Excluded
2026/07/26 04:47:52 DEBUG : dir1/0012-6789;.txt: Excluded (Path Filter)
2026/07/26 04:47:52 DEBUG : dir1/0012-6789;.txt: Excluded
2026/07/26 04:47:52 DEBUG : dir1/0013-789;=.txt: Excluded (Path Filter)
2026/07/26 04:47:52 DEBUG : dir1/0013-789;=.txt: Excluded
2026/07/26 04:47:52 DEBUG : dir1/0014-89;=.txt: Excluded (Path Filter)
2026/07/26 04:47:52 DEBUG : dir1/0014-89;=.txt: Excluded
2026/07/26 04:47:52 DEBUG : dir1/0015-9;=.txt: Excluded (Path Filter)
2026/07/26 04:47:52 DEBUG : dir1/0015-9;=.txt: Excluded
2026/07/26 04:47:52 DEBUG : apple: size = 5 OK
2026/07/26 04:47:52 DEBUG : apple: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:52 DEBUG : apple: Unchanged skipping
2026/07/26 04:47:52 DEBUG : appleappleapplebanana: size = 21 OK
2026/07/26 04:47:52 DEBUG : appleappleapplebanana: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:52 DEBUG : appleappleapplebanana: Unchanged skipping
2026/07/26 04:47:52 DEBUG : banana: size = 6 OK
2026/07/26 04:47:52 DEBUG : banana: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:52 DEBUG : banana: Unchanged skipping
2026/07/26 04:47:52 INFO  : dir1: Set directory modification time (using DirSetModTime)
2026/07/26 04:47:52 DEBUG : Added delayed dir = "dir1", newDst=dir1
2026/07/26 04:47:52 DEBUG : splitbananasplit: size = 16 OK
2026/07/26 04:47:52 DEBUG : splitbananasplit: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:52 DEBUG : splitbananasplit: Unchanged skipping
2026/07/26 04:47:52 DEBUG : dir1/0000-abcdefg.txt: size = 21 OK
2026/07/26 04:47:52 DEBUG : dir1/0000-abcdefg.txt: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:52 DEBUG : dir1/0000-abcdefg.txt: Unchanged skipping
2026/07/26 04:47:52 DEBUG : dir1/0003-defghij.txt: size = 21 OK
2026/07/26 04:47:52 DEBUG : dir1/0003-defghij.txt: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:52 DEBUG : dir1/0003-defghij.txt: Unchanged skipping
2026/07/26 04:47:52 DEBUG : dir1/0001-bcdefgh.txt: size = 21 OK
2026/07/26 04:47:52 DEBUG : dir1/0005-fghijkl.txt: size = 21 OK
2026/07/26 04:47:52 DEBUG : dir1/0005-fghijkl.txt: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:52 DEBUG : dir1/0005-fghijkl.txt: Unchanged skipping
2026/07/26 04:47:52 DEBUG : dir1/0006-ghijklm.txt: size = 21 OK
2026/07/26 04:47:52 DEBUG : dir1/0001-bcdefgh.txt: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:52 DEBUG : dir1/0002-cdefghi.txt: size = 21 OK
2026/07/26 04:47:52 DEBUG : dir1/0008-2345678.txt: size = 21 OK
2026/07/26 04:47:52 DEBUG : dir1/0001-bcdefgh.txt: Unchanged skipping
2026/07/26 04:47:52 DEBUG : dir1/0010-456789.txt: size = 20 OK
2026/07/26 04:47:52 DEBUG : dir1/0009-3456789.txt: size = 21 OK
2026/07/26 04:47:52 DEBUG : files root 'rclone-test-pojagiv1lila': Waiting for checks to finish
2026/07/26 04:47:52 DEBUG : dir1/0008-2345678.txt: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:52 DEBUG : dir1/0009-3456789.txt: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:52 DEBUG : dir1/0008-2345678.txt: Unchanged skipping
2026/07/26 04:47:52 DEBUG : dir1/0011-56789;.txt: size = 20 OK
2026/07/26 04:47:52 DEBUG : dir1/0011-56789;.txt: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:52 DEBUG : dir1/0011-56789;.txt: Unchanged skipping
2026/07/26 04:47:52 DEBUG : dir1/0012-6789;.txt: size = 19 OK
2026/07/26 04:47:52 DEBUG : dir1/0012-6789;.txt: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:52 DEBUG : dir1/0010-456789.txt: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:52 DEBUG : dir1/0012-6789;.txt: Unchanged skipping
2026/07/26 04:47:52 DEBUG : dir1/0010-456789.txt: Unchanged skipping
2026/07/26 04:47:52 DEBUG : dir1/0013-789;=.txt: size = 19 OK
2026/07/26 04:47:52 DEBUG : dir1/0014-89;=.txt: size = 18 OK
2026/07/26 04:47:52 DEBUG : dir1/0013-789;=.txt: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:52 DEBUG : dir1/0013-789;=.txt: Unchanged skipping
2026/07/26 04:47:52 DEBUG : dir1/0014-89;=.txt: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:52 DEBUG : dir1/0014-89;=.txt: Unchanged skipping
2026/07/26 04:47:52 DEBUG : dir1/0009-3456789.txt: Unchanged skipping
2026/07/26 04:47:52 DEBUG : dir1/0007-1234567.txt: size = 21 OK
2026/07/26 04:47:52 DEBUG : dir1/0007-1234567.txt: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:52 DEBUG : dir1/0007-1234567.txt: Unchanged skipping
2026/07/26 04:47:52 DEBUG : dir1/0002-cdefghi.txt: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:52 DEBUG : dir1/0002-cdefghi.txt: Unchanged skipping
2026/07/26 04:47:52 DEBUG : dir1/0006-ghijklm.txt: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:52 DEBUG : dir1/0006-ghijklm.txt: Unchanged skipping
2026/07/26 04:47:52 DEBUG : dir1/0004-efghijk.txt: size = 21 OK
2026/07/26 04:47:52 DEBUG : dir1/0004-efghijk.txt: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:52 DEBUG : dir1/0004-efghijk.txt: Unchanged skipping
2026/07/26 04:47:52 DEBUG : dir1/0015-9;=.txt: size = 17 OK
2026/07/26 04:47:52 DEBUG : dir1/0015-9;=.txt: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:52 DEBUG : dir1/0015-9;=.txt: Unchanged skipping
2026/07/26 04:47:52 DEBUG : files root 'rclone-test-pojagiv1lila': Waiting for transfers to finish
2026/07/26 04:47:52 DEBUG : Waiting for deletions to finish
2026/07/26 04:47:52 INFO  : There was nothing to transfer
2026/07/26 04:47:52 DEBUG : Waiting for deletions to finish
2026/07/26 04:47:53 DEBUG : apple: Excluded (Path Filter)
2026/07/26 04:47:53 DEBUG : apple: Excluded
2026/07/26 04:47:53 DEBUG : appleappleapplebanana: Excluded (Path Filter)
2026/07/26 04:47:53 DEBUG : appleappleapplebanana: Excluded
2026/07/26 04:47:53 DEBUG : banana: Excluded (Path Filter)
2026/07/26 04:47:53 DEBUG : banana: Excluded
2026/07/26 04:47:53 DEBUG : splitbananasplit: Excluded (Path Filter)
2026/07/26 04:47:53 DEBUG : splitbananasplit: Excluded
2026/07/26 04:47:53 DEBUG : dir1/0000-abcdefg.txt: Excluded (Path Filter)
2026/07/26 04:47:53 DEBUG : dir1/0000-abcdefg.txt: Excluded
2026/07/26 04:47:53 DEBUG : dir1/0001-bcdefgh.txt: Excluded (Path Filter)
2026/07/26 04:47:53 DEBUG : dir1/0001-bcdefgh.txt: Excluded
2026/07/26 04:47:53 DEBUG : dir1/0002-cdefghi.txt: Excluded (Path Filter)
2026/07/26 04:47:53 DEBUG : dir1/0002-cdefghi.txt: Excluded
2026/07/26 04:47:53 DEBUG : dir1/0003-defghij.txt: Excluded (Path Filter)
2026/07/26 04:47:53 DEBUG : dir1/0003-defghij.txt: Excluded
2026/07/26 04:47:53 DEBUG : dir1/0004-efghijk.txt: Excluded (Path Filter)
2026/07/26 04:47:53 DEBUG : dir1/0004-efghijk.txt: Excluded
2026/07/26 04:47:53 DEBUG : dir1/0005-fghijkl.txt: Excluded (Path Filter)
2026/07/26 04:47:53 DEBUG : dir1/0005-fghijkl.txt: Excluded
2026/07/26 04:47:53 DEBUG : dir1/0006-ghijklm.txt: Excluded (Path Filter)
2026/07/26 04:47:53 DEBUG : dir1/0006-ghijklm.txt: Excluded
2026/07/26 04:47:53 DEBUG : dir1/0007-1234567.txt: Excluded (Path Filter)
2026/07/26 04:47:53 DEBUG : dir1/0007-1234567.txt: Excluded
2026/07/26 04:47:53 DEBUG : dir1/0008-2345678.txt: Excluded (Path Filter)
2026/07/26 04:47:53 DEBUG : dir1/0008-2345678.txt: Excluded
2026/07/26 04:47:53 DEBUG : dir1/0009-3456789.txt: Excluded (Path Filter)
2026/07/26 04:47:53 DEBUG : dir1/0009-3456789.txt: Excluded
2026/07/26 04:47:53 DEBUG : dir1/0010-456789.txt: Excluded (Path Filter)
2026/07/26 04:47:53 DEBUG : dir1/0010-456789.txt: Excluded
2026/07/26 04:47:53 DEBUG : dir1/0011-56789;.txt: Excluded (Path Filter)
2026/07/26 04:47:53 DEBUG : dir1/0011-56789;.txt: Excluded
2026/07/26 04:47:53 DEBUG : dir1/0012-6789;.txt: Excluded (Path Filter)
2026/07/26 04:47:53 DEBUG : dir1/0012-6789;.txt: Excluded
2026/07/26 04:47:53 DEBUG : dir1/0013-789;=.txt: Excluded (Path Filter)
2026/07/26 04:47:53 DEBUG : dir1/0013-789;=.txt: Excluded
2026/07/26 04:47:53 DEBUG : dir1/0014-89;=.txt: Excluded (Path Filter)
2026/07/26 04:47:53 DEBUG : dir1/0014-89;=.txt: Excluded
2026/07/26 04:47:53 DEBUG : dir1/0015-9;=.txt: Excluded (Path Filter)
2026/07/26 04:47:53 DEBUG : dir1/0015-9;=.txt: Excluded
2026/07/26 04:47:53 DEBUG : dir1: Directory modification time the same (differ by -348.596234ms, within tolerance 1s)
2026/07/26 04:47:53 DEBUG : Added delayed dir = "dir1", newDst=dir1
2026/07/26 04:47:53 DEBUG : banana: size = 6 OK
2026/07/26 04:47:53 DEBUG : banana: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:53 DEBUG : banana: Unchanged skipping
2026/07/26 04:47:53 DEBUG : apple: size = 5 OK
2026/07/26 04:47:53 DEBUG : apple: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:53 DEBUG : apple: Unchanged skipping
2026/07/26 04:47:53 DEBUG : appleappleapplebanana: size = 21 OK
2026/07/26 04:47:53 DEBUG : appleappleapplebanana: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:53 DEBUG : splitbananasplit: size = 16 OK
2026/07/26 04:47:53 DEBUG : splitbananasplit: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:53 DEBUG : splitbananasplit: Unchanged skipping
2026/07/26 04:47:53 DEBUG : appleappleapplebanana: Unchanged skipping
2026/07/26 04:47:53 DEBUG : dir1/0001-bcdefgh.txt: size = 21 OK
2026/07/26 04:47:53 DEBUG : dir1/0001-bcdefgh.txt: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:53 DEBUG : dir1/0001-bcdefgh.txt: Unchanged skipping
2026/07/26 04:47:53 DEBUG : dir1/0000-abcdefg.txt: size = 21 OK
2026/07/26 04:47:53 DEBUG : dir1/0004-efghijk.txt: size = 21 OK
2026/07/26 04:47:53 DEBUG : dir1/0004-efghijk.txt: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:53 DEBUG : dir1/0004-efghijk.txt: Unchanged skipping
2026/07/26 04:47:53 DEBUG : dir1/0000-abcdefg.txt: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:53 DEBUG : dir1/0007-1234567.txt: size = 21 OK
2026/07/26 04:47:53 DEBUG : dir1/0000-abcdefg.txt: Unchanged skipping
2026/07/26 04:47:53 DEBUG : dir1/0007-1234567.txt: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:53 DEBUG : dir1/0005-fghijkl.txt: size = 21 OK
2026/07/26 04:47:53 DEBUG : dir1/0009-3456789.txt: size = 21 OK
2026/07/26 04:47:53 DEBUG : dir1/0003-defghij.txt: size = 21 OK
2026/07/26 04:47:53 DEBUG : dir1/0009-3456789.txt: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:53 DEBUG : dir1/0002-cdefghi.txt: size = 21 OK
2026/07/26 04:47:53 DEBUG : dir1/0003-defghij.txt: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:53 DEBUG : dir1/0002-cdefghi.txt: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:53 DEBUG : dir1/0003-defghij.txt: Unchanged skipping
2026/07/26 04:47:53 DEBUG : dir1/0008-2345678.txt: size = 21 OK
2026/07/26 04:47:53 DEBUG : dir1/0008-2345678.txt: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:53 DEBUG : dir1/0008-2345678.txt: Unchanged skipping
2026/07/26 04:47:53 DEBUG : dir1/0010-456789.txt: size = 20 OK
2026/07/26 04:47:53 DEBUG : dir1/0012-6789;.txt: size = 19 OK
2026/07/26 04:47:53 DEBUG : dir1/0010-456789.txt: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:53 DEBUG : dir1/0011-56789;.txt: size = 20 OK
2026/07/26 04:47:53 DEBUG : dir1/0010-456789.txt: Unchanged skipping
2026/07/26 04:47:53 DEBUG : dir1/0007-1234567.txt: Unchanged skipping
2026/07/26 04:47:53 DEBUG : dir1/0011-56789;.txt: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:53 DEBUG : dir1/0014-89;=.txt: size = 18 OK
2026/07/26 04:47:53 DEBUG : dir1/0014-89;=.txt: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:53 DEBUG : dir1/0006-ghijklm.txt: size = 21 OK
2026/07/26 04:47:53 DEBUG : dir1/0009-3456789.txt: Unchanged skipping
2026/07/26 04:47:53 DEBUG : dir1/0015-9;=.txt: size = 17 OK
2026/07/26 04:47:53 DEBUG : dir1/0006-ghijklm.txt: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:53 DEBUG : dir1/0015-9;=.txt: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:53 DEBUG : dir1/0006-ghijklm.txt: Unchanged skipping
2026/07/26 04:47:53 DEBUG : dir1/0011-56789;.txt: Unchanged skipping
2026/07/26 04:47:53 DEBUG : dir1/0002-cdefghi.txt: Unchanged skipping
2026/07/26 04:47:53 DEBUG : dir1/0013-789;=.txt: size = 19 OK
2026/07/26 04:47:53 DEBUG : dir1/0013-789;=.txt: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:53 DEBUG : dir1/0013-789;=.txt: Unchanged skipping
2026/07/26 04:47:53 DEBUG : files root 'rclone-test-pojagiv1lila': Waiting for checks to finish
2026/07/26 04:47:53 DEBUG : dir1/0012-6789;.txt: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:53 DEBUG : dir1/0012-6789;.txt: Unchanged skipping
2026/07/26 04:47:53 DEBUG : dir1/0005-fghijkl.txt: Size and modification time the same (differ by -499.999999ms, within tolerance 1s)
2026/07/26 04:47:53 DEBUG : dir1/0005-fghijkl.txt: Unchanged skipping
2026/07/26 04:47:53 DEBUG : dir1/0014-89;=.txt: Unchanged skipping
2026/07/26 04:47:53 DEBUG : dir1/0015-9;=.txt: Unchanged skipping
2026/07/26 04:47:53 DEBUG : files root 'rclone-test-pojagiv1lila': Waiting for transfers to finish
2026/07/26 04:47:53 DEBUG : Waiting for deletions to finish
2026/07/26 04:47:53 INFO  : There was nothing to transfer
2026/07/26 04:47:53 DEBUG : Waiting for deletions to finish
2026/07/26 04:47:53 DEBUG : apple: Excluded (Path Filter)
2026/07/26 04:47:53 DEBUG : apple: Excluded
2026/07/26 04:47:53 DEBUG : appleappleapplebanana: Excluded (Path Filter)
2026/07/26 04:47:53 DEBUG : appleappleapplebanana: Excluded
2026/07/26 04:47:53 DEBUG : banana: Excluded (Path Filter)
2026/07/26 04:47:53 DEBUG : banana: Excluded
2026/07/26 04:47:53 DEBUG : splitbananasplit: Excluded (Path Filter)
2026/07/26 04:47:53 DEBUG : splitbananasplit: Excluded
2026/07/26 04:47:54 DEBUG : dir1/0000-abcdefg.txt: Excluded (Path Filter)
2026/07/26 04:47:54 DEBUG : dir1/0000-abcdefg.txt: Excluded
2026/07/26 04:47:54 DEBUG : dir1/0001-bcdefgh.txt: Excluded (Path Filter)
2026/07/26 04:47:54 DEBUG : dir1/0001-bcdefgh.txt: Excluded
2026/07/26 04:47:54 DEBUG : dir1/0002-cdefghi.txt: Excluded (Path Filter)
2026/07/26 04:47:54 DEBUG : dir1/0002-cdefghi.txt: Excluded
2026/07/26 04:47:54 DEBUG : dir1/0003-defghij.txt: Excluded (Path Filter)
2026/07/26 04:47:54 DEBUG : dir1/0003-defghij.txt: Excluded
2026/07/26 04:47:54 DEBUG : dir1/0004-efghijk.txt: Excluded (Path Filter)
2026/07/26 04:47:54 DEBUG : dir1/0004-efghijk.txt: Excluded
2026/07/26 04:47:54 DEBUG : dir1/0005-fghijkl.txt: Excluded (Path Filter)
2026/07/26 04:47:54 DEBUG : dir1/0005-fghijkl.txt: Excluded
2026/07/26 04:47:54 DEBUG : dir1/0006-ghijklm.txt: Excluded (Path Filter)
2026/07/26 04:47:54 DEBUG : dir1/0006-ghijklm.txt: Excluded
2026/07/26 04:47:54 DEBUG : dir1/0007-1234567.txt: Excluded (Path Filter)
2026/07/26 04:47:54 DEBUG : dir1/0007-1234567.txt: Excluded
2026/07/26 04:47:54 DEBUG : dir1/0008-2345678.txt: Excluded (Path Filter)
2026/07/26 04:47:54 DEBUG : dir1/0008-2345678.txt: Excluded
2026/07/26 04:47:54 DEBUG : dir1/0009-3456789.txt: Excluded (Path Filter)
2026/07/26 04:47:54 DEBUG : dir1/0009-3456789.txt: Excluded
2026/07/26 04:47:54 DEBUG : dir1/0010-456789.txt: Excluded (Path Filter)
2026/07/26 04:47:54 DEBUG : dir1/0010-456789.txt: Excluded
2026/07/26 04:47:54 DEBUG : dir1/0011-56789;.txt: Excluded (Path Filter)
2026/07/26 04:47:54 DEBUG : dir1/0011-56789;.txt: Excluded
2026/07/26 04:47:54 DEBUG : dir1/0012-6789;.txt: Excluded (Path Filter)
2026/07/26 04:47:54 DEBUG : dir1/0012-6789;.txt: Excluded
2026/07/26 04:47:54 DEBUG : dir1/0013-789;=.txt: Excluded (Path Filter)
2026/07/26 04:47:54 DEBUG : dir1/0013-789;=.txt: Excluded
2026/07/26 04:47:54 DEBUG : dir1/0014-89;=.txt: Excluded (Path Filter)
2026/07/26 04:47:54 DEBUG : dir1/0014-89;=.txt: Excluded
2026/07/26 04:47:54 DEBUG : dir1/0015-9;=.txt: Excluded (Path Filter)
2026/07/26 04:47:54 DEBUG : dir1/0015-9;=.txt: Excluded
--- PASS: TestTransform (47.42s)
    --- PASS: TestTransform/ISO-8859-1 (47.42s)
PASS
2026/07/26 04:47:58 DEBUG : files root 'rclone-test-pojagiv1lila': Purge remote
"./sync.test -test.v -test.timeout 1h0m0s -remote TestFilesCom: -verbose -test.run '^(TestCopyAfterDelete|TestFixCase|TestServerSideCopy|TestSyncBackupDirSuffixOnly|TestSyncEmptyDirectories|TestSyncNoEmptyDirectories|TestSyncNoTraverse|TestSyncNoUpdateDirModtime|TestSyncReplaceDirModTimeWithEmptyDirs|TestSyncSetDelayedModTimes)$|^TestTransform$/^ISO-8859-1$'" - Finished OK in 1m59.574809589s (try 2/5)