"./sync.test -test.v -test.timeout 1h0m0s -remote TestProtonDrive: -verbose -test.run '^(TestMoveWithDeleteEmptySrcDirs|TestServerSideMove|TestServerSideMoveDeleteEmptySourceDirs|TestServerSideMoveOverSelf|TestServerSideMoveWithFilter|TestSyncBackupDir|TestSyncBackupDirSuffixOnly|TestSyncBackupDirWithSuffix|TestSyncBackupDirWithSuffixKeepExtension|TestSyncSuffix|TestSyncSuffixKeepExtension|TestSyncWithTrackRenames|TestSyncWithTrackRenamesStrategyLeaf|TestSyncWithTrackRenamesStrategyModtime)$'" - Starting (try 5/5) 2025/07/18 04:03:18 DEBUG : Creating backend with remote "TestProtonDrive:rclone-test-vikoced2piva" 2025/07/18 04:03:18 DEBUG : Using config file from "/home/rclone/.rclone.conf" 2025/07/18 04:03:18 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva': Has cached credentials 2025/07/18 04:03:19 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva': Used cached credential to initialize the ProtonDrive API 2025/07/18 04:03:19 DEBUG : Creating backend with remote "/tmp/rclone3627183167" === RUN TestServerSideMoveOverSelf run.go:180: Remote "proton drive root link ID 'rclone-test-vikoced2piva'", Local "Local file system at /tmp/rclone3627183167", Modify Window "1s" 2025/07/18 04:03:22 DEBUG : Creating backend with remote "TestProtonDrive:rclone-test-giqupak8qave" 2025/07/18 04:03:22 DEBUG : proton drive root link ID 'rclone-test-giqupak8qave': Has cached credentials 2025/07/18 04:03:23 DEBUG : proton drive root link ID 'rclone-test-giqupak8qave': Used cached credential to initialize the ProtonDrive API sync_test.go:701: Server side copy (if possible) proton drive root link ID 'rclone-test-vikoced2piva' -> proton drive root link ID 'rclone-test-giqupak8qave' 2025/07/18 04:03:24 DEBUG : sub dir/hello world: Need to transfer - File not found at Destination 2025/07/18 04:03:24 DEBUG : proton drive root link ID 'rclone-test-giqupak8qave': Waiting for checks to finish 2025/07/18 04:03:24 DEBUG : proton drive root link ID 'rclone-test-giqupak8qave': Waiting for transfers to finish 2025/07/18 04:03:27 DEBUG : sub dir/hello world: sha1 = 2aae6c35c94fcfb415dbe95f408b9ce91ee846ed OK 2025/07/18 04:03:27 INFO : sub dir/hello world: Copied (new) 2025/07/18 04:03:28.267797 WARN RESTY 422 POST https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/files: A file or folder with that name already exists (Code=2500, Status=422), Attempt 1 2025/07/18 04:03:28.267819 ERROR RESTY 422 POST https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/files: A file or folder with that name already exists (Code=2500, Status=422) 2025/07/18 04:03:30 DEBUG : proton drive root link ID 'rclone-test-giqupak8qave': Using server-side directory move 2025/07/18 04:03:30 INFO : proton drive root link ID 'rclone-test-giqupak8qave': Server side directory move failed - fallback to file moves: can't copy directory - destination already exists 2025/07/18 04:03:30 DEBUG : proton drive root link ID 'rclone-test-giqupak8qave': Waiting for checks to finish 2025/07/18 04:03:30 DEBUG : sub dir/hello world: Sizes differ (src 17 vs dst 11) 2025/07/18 04:03:30 DEBUG : proton drive root link ID 'rclone-test-giqupak8qave': Waiting for transfers to finish 2025/07/18 04:03:30 INFO : sub dir/hello world: Deleted 2025/07/18 04:03:31.638777 WARN RESTY 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/sratCJaBmBvC8VNQNQeT7KbEMNJmhMWj6Q5gb9SYHjRUjGvmfEstJJxLYipzXIO5r2Vr15VAwgeaFyW3E_0X9g==/move: This value should not be blank. (Code=2000, Status=400), Attempt 1 2025/07/18 04:03:31.638816 ERROR RESTY 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/sratCJaBmBvC8VNQNQeT7KbEMNJmhMWj6Q5gb9SYHjRUjGvmfEstJJxLYipzXIO5r2Vr15VAwgeaFyW3E_0X9g==/move: This value should not be blank. (Code=2000, Status=400) 2025/07/18 04:03:31 ERROR : sub dir/hello world: Couldn't move: 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/sratCJaBmBvC8VNQNQeT7KbEMNJmhMWj6Q5gb9SYHjRUjGvmfEstJJxLYipzXIO5r2Vr15VAwgeaFyW3E_0X9g==/move: This value should not be blank. (Code=2000, Status=400) sync_test.go:714: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:714 Error: Received unexpected error: 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/sratCJaBmBvC8VNQNQeT7KbEMNJmhMWj6Q5gb9SYHjRUjGvmfEstJJxLYipzXIO5r2Vr15VAwgeaFyW3E_0X9g==/move: This value should not be blank. (Code=2000, Status=400) Test: TestServerSideMoveOverSelf 2025/07/18 04:03:31 DEBUG : proton drive root link ID 'rclone-test-giqupak8qave': Purge remote --- FAIL: TestServerSideMoveOverSelf (13.50s) === RUN TestSyncWithTrackRenames run.go:180: Remote "proton drive root link ID 'rclone-test-vikoced2piva'", Local "Local file system at /tmp/rclone3627183167", Modify Window "1s" sync_test.go:1568: Can track renames: true 2025/07/18 04:03:33 INFO : proton drive root link ID 'rclone-test-vikoced2piva': Making map for --track-renames 2025/07/18 04:03:33 INFO : proton drive root link ID 'rclone-test-vikoced2piva': Finished making map for --track-renames 2025/07/18 04:03:33 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva': Waiting for checks to finish 2025/07/18 04:03:33 DEBUG : potato: Need to transfer - No matching file found at Destination 2025/07/18 04:03:33 DEBUG : yam: Need to transfer - No matching file found at Destination 2025/07/18 04:03:33 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva': Waiting for renames to finish 2025/07/18 04:03:33 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva': Waiting for transfers to finish 2025/07/18 04:03:34 DEBUG : potato: sha1 = 1d1ac61cfffcfdd0a15cc9ae575fb06ca8c11fb5 OK 2025/07/18 04:03:34 INFO : potato: Copied (new) 2025/07/18 04:03:34 DEBUG : yam: sha1 = ad84b2fb6729688a5ee3225164a6d4d58465b33e OK 2025/07/18 04:03:34 INFO : yam: Copied (new) 2025/07/18 04:03:34 DEBUG : Waiting for deletions to finish 2025/07/18 04:03:35 DEBUG : potato: Size and modification time the same (differ by -499.999999ms, within tolerance 1s) 2025/07/18 04:03:35 INFO : proton drive root link ID 'rclone-test-vikoced2piva': Making map for --track-renames 2025/07/18 04:03:35 INFO : proton drive root link ID 'rclone-test-vikoced2piva': Finished making map for --track-renames 2025/07/18 04:03:35 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva': Waiting for checks to finish 2025/07/18 04:03:35 DEBUG : potato: Unchanged skipping 2025/07/18 04:03:35 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva': Waiting for renames to finish 2025/07/18 04:03:36.108052 WARN RESTY 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/3lxgfqtaG4FuD9E4VVpMIuAEwoTXr3LVAwHlS_lxE9Jc2JxTwSEf_QaytfGiBn0WpFcp0YTy73gDuOZQC1Y75g==/move: This value should not be blank. (Code=2000, Status=400), Attempt 1 2025/07/18 04:03:36.108100 ERROR RESTY 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/3lxgfqtaG4FuD9E4VVpMIuAEwoTXr3LVAwHlS_lxE9Jc2JxTwSEf_QaytfGiBn0WpFcp0YTy73gDuOZQC1Y75g==/move: This value should not be blank. (Code=2000, Status=400) 2025/07/18 04:03:36 ERROR : yam: Couldn't move: 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/3lxgfqtaG4FuD9E4VVpMIuAEwoTXr3LVAwHlS_lxE9Jc2JxTwSEf_QaytfGiBn0WpFcp0YTy73gDuOZQC1Y75g==/move: This value should not be blank. (Code=2000, Status=400) 2025/07/18 04:03:36 DEBUG : yaml: Failed to rename to "yam": 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/3lxgfqtaG4FuD9E4VVpMIuAEwoTXr3LVAwHlS_lxE9Jc2JxTwSEf_QaytfGiBn0WpFcp0YTy73gDuOZQC1Y75g==/move: This value should not be blank. (Code=2000, Status=400) 2025/07/18 04:03:36 DEBUG : yaml: Need to transfer - No matching file found at Destination 2025/07/18 04:03:36 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva': Waiting for transfers to finish 2025/07/18 04:03:37 DEBUG : yaml: sha1 = ad84b2fb6729688a5ee3225164a6d4d58465b33e OK 2025/07/18 04:03:37 INFO : yaml: Copied (new) 2025/07/18 04:03:37 ERROR : proton drive root link ID 'rclone-test-vikoced2piva': not deleting files as there were IO errors 2025/07/18 04:03:37 ERROR : proton drive root link ID 'rclone-test-vikoced2piva': not deleting directories as there were IO errors sync_test.go:1586: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:1586 Error: Received unexpected error: not deleting files as there were IO errors Test: TestSyncWithTrackRenames --- FAIL: TestSyncWithTrackRenames (5.50s) === RUN TestSyncWithTrackRenamesStrategyModtime run.go:180: Remote "proton drive root link ID 'rclone-test-vikoced2piva'", Local "Local file system at /tmp/rclone3627183167", Modify Window "1s" sync_test.go:1640: Can track renames: true 2025/07/18 04:03:38 INFO : proton drive root link ID 'rclone-test-vikoced2piva': Making map for --track-renames 2025/07/18 04:03:38 INFO : proton drive root link ID 'rclone-test-vikoced2piva': Finished making map for --track-renames 2025/07/18 04:03:38 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva': Waiting for checks to finish 2025/07/18 04:03:38 DEBUG : yam: Need to transfer - No matching file found at Destination 2025/07/18 04:03:38 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva': Waiting for renames to finish 2025/07/18 04:03:38 DEBUG : potato: Need to transfer - No matching file found at Destination 2025/07/18 04:03:38 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva': Waiting for transfers to finish 2025/07/18 04:03:40 DEBUG : potato: sha1 = 1d1ac61cfffcfdd0a15cc9ae575fb06ca8c11fb5 OK 2025/07/18 04:03:40 INFO : potato: Copied (new) 2025/07/18 04:03:40 DEBUG : yam: sha1 = ad84b2fb6729688a5ee3225164a6d4d58465b33e OK 2025/07/18 04:03:40 INFO : yam: Copied (new) 2025/07/18 04:03:40 DEBUG : Waiting for deletions to finish 2025/07/18 04:03:41 DEBUG : potato: Size and modification time the same (differ by -499.999999ms, within tolerance 1s) 2025/07/18 04:03:41 INFO : proton drive root link ID 'rclone-test-vikoced2piva': Making map for --track-renames 2025/07/18 04:03:41 INFO : proton drive root link ID 'rclone-test-vikoced2piva': Finished making map for --track-renames 2025/07/18 04:03:41 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva': Waiting for checks to finish 2025/07/18 04:03:41 DEBUG : potato: Unchanged skipping 2025/07/18 04:03:41 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva': Waiting for renames to finish 2025/07/18 04:03:41.473376 WARN RESTY 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/fGQdn8_2XvAjgiN6y1uYCiSJbGPh5aDyQ8yurKqYVS2l1TdBprkiVeDHP920I07ce26srHJKAzGjon4SikcBAg==/move: This value should not be blank. (Code=2000, Status=400), Attempt 1 2025/07/18 04:03:41.473412 ERROR RESTY 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/fGQdn8_2XvAjgiN6y1uYCiSJbGPh5aDyQ8yurKqYVS2l1TdBprkiVeDHP920I07ce26srHJKAzGjon4SikcBAg==/move: This value should not be blank. (Code=2000, Status=400) 2025/07/18 04:03:41 ERROR : yam: Couldn't move: 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/fGQdn8_2XvAjgiN6y1uYCiSJbGPh5aDyQ8yurKqYVS2l1TdBprkiVeDHP920I07ce26srHJKAzGjon4SikcBAg==/move: This value should not be blank. (Code=2000, Status=400) 2025/07/18 04:03:41 DEBUG : yaml: Failed to rename to "yam": 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/fGQdn8_2XvAjgiN6y1uYCiSJbGPh5aDyQ8yurKqYVS2l1TdBprkiVeDHP920I07ce26srHJKAzGjon4SikcBAg==/move: This value should not be blank. (Code=2000, Status=400) 2025/07/18 04:03:41 DEBUG : yaml: Need to transfer - No matching file found at Destination 2025/07/18 04:03:41 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva': Waiting for transfers to finish 2025/07/18 04:03:42 DEBUG : yaml: sha1 = ad84b2fb6729688a5ee3225164a6d4d58465b33e OK 2025/07/18 04:03:42 INFO : yaml: Copied (new) 2025/07/18 04:03:42 ERROR : proton drive root link ID 'rclone-test-vikoced2piva': not deleting files as there were IO errors 2025/07/18 04:03:42 ERROR : proton drive root link ID 'rclone-test-vikoced2piva': not deleting directories as there were IO errors sync_test.go:1658: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:1658 Error: Received unexpected error: not deleting files as there were IO errors Test: TestSyncWithTrackRenamesStrategyModtime --- FAIL: TestSyncWithTrackRenamesStrategyModtime (5.41s) === RUN TestSyncWithTrackRenamesStrategyLeaf run.go:180: Remote "proton drive root link ID 'rclone-test-vikoced2piva'", Local "Local file system at /tmp/rclone3627183167", Modify Window "1s" sync_test.go:1679: Can track renames: true 2025/07/18 04:03:44 INFO : proton drive root link ID 'rclone-test-vikoced2piva': Making map for --track-renames 2025/07/18 04:03:44 INFO : proton drive root link ID 'rclone-test-vikoced2piva': Finished making map for --track-renames 2025/07/18 04:03:44 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva': Waiting for checks to finish 2025/07/18 04:03:44 DEBUG : potato: Need to transfer - No matching file found at Destination 2025/07/18 04:03:44 DEBUG : sub/yam: Need to transfer - No matching file found at Destination 2025/07/18 04:03:44 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva': Waiting for renames to finish 2025/07/18 04:03:44 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva': Waiting for transfers to finish 2025/07/18 04:03:46 DEBUG : potato: sha1 = 1d1ac61cfffcfdd0a15cc9ae575fb06ca8c11fb5 OK 2025/07/18 04:03:46 INFO : potato: Copied (new) 2025/07/18 04:03:46 DEBUG : sub/yam: sha1 = ad84b2fb6729688a5ee3225164a6d4d58465b33e OK 2025/07/18 04:03:46 INFO : sub/yam: Copied (new) 2025/07/18 04:03:46 DEBUG : Waiting for deletions to finish 2025/07/18 04:03:47 DEBUG : potato: Size and modification time the same (differ by -499.999999ms, within tolerance 1s) 2025/07/18 04:03:47 DEBUG : potato: Unchanged skipping 2025/07/18 04:03:47 INFO : proton drive root link ID 'rclone-test-vikoced2piva': Making map for --track-renames 2025/07/18 04:03:47 INFO : proton drive root link ID 'rclone-test-vikoced2piva': Finished making map for --track-renames 2025/07/18 04:03:47 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva': Waiting for checks to finish 2025/07/18 04:03:47 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva': Waiting for renames to finish 2025/07/18 04:03:47.742362 WARN RESTY 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/5Kh96__XIosuQcgWjUGolDGYD0C0OcWLhj5HcC4BPfr8OZGb5K4MWja2xlmBCpVbhVTvUID_UXFk1J-R_G886g==/move: This value should not be blank. (Code=2000, Status=400), Attempt 1 2025/07/18 04:03:47.742394 ERROR RESTY 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/5Kh96__XIosuQcgWjUGolDGYD0C0OcWLhj5HcC4BPfr8OZGb5K4MWja2xlmBCpVbhVTvUID_UXFk1J-R_G886g==/move: This value should not be blank. (Code=2000, Status=400) 2025/07/18 04:03:47 ERROR : sub/yam: Couldn't move: 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/5Kh96__XIosuQcgWjUGolDGYD0C0OcWLhj5HcC4BPfr8OZGb5K4MWja2xlmBCpVbhVTvUID_UXFk1J-R_G886g==/move: This value should not be blank. (Code=2000, Status=400) 2025/07/18 04:03:47 DEBUG : yam: Failed to rename to "sub/yam": 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/5Kh96__XIosuQcgWjUGolDGYD0C0OcWLhj5HcC4BPfr8OZGb5K4MWja2xlmBCpVbhVTvUID_UXFk1J-R_G886g==/move: This value should not be blank. (Code=2000, Status=400) 2025/07/18 04:03:47 DEBUG : yam: Need to transfer - No matching file found at Destination 2025/07/18 04:03:47 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva': Waiting for transfers to finish 2025/07/18 04:03:49 DEBUG : yam: sha1 = ad84b2fb6729688a5ee3225164a6d4d58465b33e OK 2025/07/18 04:03:49 INFO : yam: Copied (new) 2025/07/18 04:03:49 ERROR : proton drive root link ID 'rclone-test-vikoced2piva': not deleting files as there were IO errors 2025/07/18 04:03:49 ERROR : proton drive root link ID 'rclone-test-vikoced2piva': not deleting directories as there were IO errors sync_test.go:1697: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:1697 Error: Received unexpected error: not deleting files as there were IO errors Test: TestSyncWithTrackRenamesStrategyLeaf --- FAIL: TestSyncWithTrackRenamesStrategyLeaf (6.78s) === RUN TestMoveWithDeleteEmptySrcDirs run.go:180: Remote "proton drive root link ID 'rclone-test-vikoced2piva'", Local "Local file system at /tmp/rclone3627183167", Modify Window "1s" 2025/07/18 04:03:51 DEBUG : sub dir/hello world: Need to transfer - File not found at Destination 2025/07/18 04:03:51 DEBUG : nested/sub dir/file: Need to transfer - File not found at Destination 2025/07/18 04:03:51 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva': Waiting for checks to finish 2025/07/18 04:03:51 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva': Waiting for transfers to finish 2025/07/18 04:03:53 DEBUG : nested/sub dir/file: sha1 = b4b3e0a278988bc15f2913af3f4153ccef74e465 OK 2025/07/18 04:03:53 INFO : nested/sub dir/file: Copied (new) 2025/07/18 04:03:53 INFO : nested/sub dir/file: Deleted 2025/07/18 04:03:53 DEBUG : sub dir/hello world: sha1 = 2aae6c35c94fcfb415dbe95f408b9ce91ee846ed OK 2025/07/18 04:03:53 INFO : sub dir/hello world: Copied (new) 2025/07/18 04:03:53 INFO : sub dir/hello world: Deleted 2025/07/18 04:03:53 ERROR : Local file system at /tmp/rclone3627183167: not deleting directories as there were IO errors sync_test.go:1818: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:1818 Error: Received unexpected error: not deleting directories as there were IO errors Test: TestMoveWithDeleteEmptySrcDirs --- FAIL: TestMoveWithDeleteEmptySrcDirs (4.79s) === RUN TestServerSideMove run.go:180: Remote "proton drive root link ID 'rclone-test-vikoced2piva'", Local "Local file system at /tmp/rclone3627183167", Modify Window "1s" 2025/07/18 04:03:55 DEBUG : Creating backend with remote "TestProtonDrive:rclone-test-cijabok3javu" 2025/07/18 04:03:55 DEBUG : proton drive root link ID 'rclone-test-cijabok3javu': Has cached credentials 2025/07/18 04:03:56 DEBUG : proton drive root link ID 'rclone-test-cijabok3javu': Used cached credential to initialize the ProtonDrive API sync_test.go:1735: Server side move (if possible) proton drive root link ID 'rclone-test-vikoced2piva' -> proton drive root link ID 'rclone-test-cijabok3javu' 2025/07/18 04:04:04 DEBUG : proton drive root link ID 'rclone-test-cijabok3javu': Using server-side directory move 2025/07/18 04:04:04 INFO : proton drive root link ID 'rclone-test-cijabok3javu': Server side directory move failed - fallback to file moves: can't copy directory - destination already exists 2025/07/18 04:04:05 DEBUG : potato2: Need to transfer - File not found at Destination 2025/07/18 04:04:05 DEBUG : empty space: Size and modification time the same (differ by 0s, within tolerance 1s) 2025/07/18 04:04:05 DEBUG : empty space: Unchanged skipping 2025/07/18 04:04:05 DEBUG : potato3: Sizes differ (src 68 vs dst 60) 2025/07/18 04:04:05 DEBUG : proton drive root link ID 'rclone-test-cijabok3javu': Waiting for checks to finish 2025/07/18 04:04:05 INFO : potato3: Deleted 2025/07/18 04:04:05 INFO : empty space: Deleted 2025/07/18 04:04:05 DEBUG : proton drive root link ID 'rclone-test-cijabok3javu': Waiting for transfers to finish 2025/07/18 04:04:05.706235 WARN RESTY 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/JRzGmxGDEfBxEsGU5y8OeBQlL-HCMNNGdRwXZzGvXFmj9wMnKLu0byimVoio_AesStv01kvAIO72oOGM2rXm2Q==/move: This value should not be blank. (Code=2000, Status=400), Attempt 1 2025/07/18 04:04:05.706265 ERROR RESTY 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/JRzGmxGDEfBxEsGU5y8OeBQlL-HCMNNGdRwXZzGvXFmj9wMnKLu0byimVoio_AesStv01kvAIO72oOGM2rXm2Q==/move: This value should not be blank. (Code=2000, Status=400) 2025/07/18 04:04:05 ERROR : potato2: Couldn't move: 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/JRzGmxGDEfBxEsGU5y8OeBQlL-HCMNNGdRwXZzGvXFmj9wMnKLu0byimVoio_AesStv01kvAIO72oOGM2rXm2Q==/move: This value should not be blank. (Code=2000, Status=400) 2025/07/18 04:04:05.782411 WARN RESTY 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/9vd6zyf0XVKB3t89E1CYVL_qbZV6mpH0lE2BB_ttYzmzGL2feeAMs1Bi6GQMfndrC5xjO7_wBniGcnGEeDapXQ==/move: This value should not be blank. (Code=2000, Status=400), Attempt 1 2025/07/18 04:04:05.782441 ERROR RESTY 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/9vd6zyf0XVKB3t89E1CYVL_qbZV6mpH0lE2BB_ttYzmzGL2feeAMs1Bi6GQMfndrC5xjO7_wBniGcnGEeDapXQ==/move: This value should not be blank. (Code=2000, Status=400) 2025/07/18 04:04:05 ERROR : potato3: Couldn't move: 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/9vd6zyf0XVKB3t89E1CYVL_qbZV6mpH0lE2BB_ttYzmzGL2feeAMs1Bi6GQMfndrC5xjO7_wBniGcnGEeDapXQ==/move: This value should not be blank. (Code=2000, Status=400) sync_test.go:1746: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:1746 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:1911 Error: Received unexpected error: 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/9vd6zyf0XVKB3t89E1CYVL_qbZV6mpH0lE2BB_ttYzmzGL2feeAMs1Bi6GQMfndrC5xjO7_wBniGcnGEeDapXQ==/move: This value should not be blank. (Code=2000, Status=400) Test: TestServerSideMove 2025/07/18 04:04:05 DEBUG : proton drive root link ID 'rclone-test-cijabok3javu': Purge remote --- FAIL: TestServerSideMove (11.49s) === RUN TestServerSideMoveWithFilter run.go:180: Remote "proton drive root link ID 'rclone-test-vikoced2piva'", Local "Local file system at /tmp/rclone3627183167", Modify Window "1s" 2025/07/18 04:04:07 DEBUG : Creating backend with remote "TestProtonDrive:rclone-test-fusaraw2ribu" 2025/07/18 04:04:07 DEBUG : proton drive root link ID 'rclone-test-fusaraw2ribu': Has cached credentials 2025/07/18 04:04:07 DEBUG : proton drive root link ID 'rclone-test-fusaraw2ribu': Used cached credential to initialize the ProtonDrive API sync_test.go:1735: Server side move (if possible) proton drive root link ID 'rclone-test-vikoced2piva' -> proton drive root link ID 'rclone-test-fusaraw2ribu' 2025/07/18 04:04:16 DEBUG : empty space: Excluded (Size Filter) 2025/07/18 04:04:16 DEBUG : empty space: Excluded 2025/07/18 04:04:16 DEBUG : empty space: Excluded (Size Filter) 2025/07/18 04:04:16 DEBUG : empty space: Excluded 2025/07/18 04:04:16 DEBUG : potato2: Need to transfer - File not found at Destination 2025/07/18 04:04:16 DEBUG : proton drive root link ID 'rclone-test-fusaraw2ribu': Waiting for checks to finish 2025/07/18 04:04:16 DEBUG : potato3: Sizes differ (src 68 vs dst 60) 2025/07/18 04:04:16 DEBUG : proton drive root link ID 'rclone-test-fusaraw2ribu': Waiting for transfers to finish 2025/07/18 04:04:16 INFO : potato3: Deleted 2025/07/18 04:04:17.091356 WARN RESTY 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/0L572K-sjp08HJ7MOaB_g28-UkRyHKstZg3XND3hpV6es4NVNm5NUWQjVJmzUTHj8xXGsVgLnWuQWDHyqhsj2A==/move: This value should not be blank. (Code=2000, Status=400), Attempt 1 2025/07/18 04:04:17.091518 ERROR RESTY 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/0L572K-sjp08HJ7MOaB_g28-UkRyHKstZg3XND3hpV6es4NVNm5NUWQjVJmzUTHj8xXGsVgLnWuQWDHyqhsj2A==/move: This value should not be blank. (Code=2000, Status=400) 2025/07/18 04:04:17 ERROR : potato2: Couldn't move: 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/0L572K-sjp08HJ7MOaB_g28-UkRyHKstZg3XND3hpV6es4NVNm5NUWQjVJmzUTHj8xXGsVgLnWuQWDHyqhsj2A==/move: This value should not be blank. (Code=2000, Status=400) 2025/07/18 04:04:17.200407 WARN RESTY 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/UTL_iDHpnOaJZdASn0or8xAa7-_kChPKWCEgrbnGLdkPuRV58lw-D_LRYObFqRsJNpgO_IvCDkjc7-8-Sv2LCQ==/move: This value should not be blank. (Code=2000, Status=400), Attempt 1 2025/07/18 04:04:17.200626 ERROR RESTY 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/UTL_iDHpnOaJZdASn0or8xAa7-_kChPKWCEgrbnGLdkPuRV58lw-D_LRYObFqRsJNpgO_IvCDkjc7-8-Sv2LCQ==/move: This value should not be blank. (Code=2000, Status=400) 2025/07/18 04:04:17 ERROR : potato3: Couldn't move: 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/UTL_iDHpnOaJZdASn0or8xAa7-_kChPKWCEgrbnGLdkPuRV58lw-D_LRYObFqRsJNpgO_IvCDkjc7-8-Sv2LCQ==/move: This value should not be blank. (Code=2000, Status=400) sync_test.go:1746: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:1746 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:1924 Error: Received unexpected error: 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/UTL_iDHpnOaJZdASn0or8xAa7-_kChPKWCEgrbnGLdkPuRV58lw-D_LRYObFqRsJNpgO_IvCDkjc7-8-Sv2LCQ==/move: This value should not be blank. (Code=2000, Status=400) Test: TestServerSideMoveWithFilter 2025/07/18 04:04:17 DEBUG : proton drive root link ID 'rclone-test-fusaraw2ribu': Purge remote --- FAIL: TestServerSideMoveWithFilter (11.72s) === RUN TestServerSideMoveDeleteEmptySourceDirs run.go:180: Remote "proton drive root link ID 'rclone-test-vikoced2piva'", Local "Local file system at /tmp/rclone3627183167", Modify Window "1s" 2025/07/18 04:04:18 DEBUG : Creating backend with remote "TestProtonDrive:rclone-test-bewoxad2sati" 2025/07/18 04:04:18 DEBUG : proton drive root link ID 'rclone-test-bewoxad2sati': Has cached credentials 2025/07/18 04:04:19 DEBUG : proton drive root link ID 'rclone-test-bewoxad2sati': Used cached credential to initialize the ProtonDrive API 2025/07/18 04:04:24 INFO : tomatoDir: Making directory sync_test.go:1735: Server side move (if possible) proton drive root link ID 'rclone-test-vikoced2piva' -> proton drive root link ID 'rclone-test-bewoxad2sati' 2025/07/18 04:04:28 DEBUG : proton drive root link ID 'rclone-test-bewoxad2sati': Using server-side directory move 2025/07/18 04:04:28 INFO : proton drive root link ID 'rclone-test-bewoxad2sati': Server side directory move failed - fallback to file moves: can't copy directory - destination already exists 2025/07/18 04:04:29 DEBUG : potato2: Need to transfer - File not found at Destination 2025/07/18 04:04:29 DEBUG : empty space: Size and modification time the same (differ by 0s, within tolerance 1s) 2025/07/18 04:04:29 DEBUG : empty space: Unchanged skipping 2025/07/18 04:04:29 DEBUG : potato3: Sizes differ (src 68 vs dst 60) 2025/07/18 04:04:29 DEBUG : proton drive root link ID 'rclone-test-bewoxad2sati': Waiting for checks to finish 2025/07/18 04:04:29 INFO : empty space: Deleted 2025/07/18 04:04:29 DEBUG : proton drive root link ID 'rclone-test-bewoxad2sati': Waiting for transfers to finish 2025/07/18 04:04:29 INFO : potato3: Deleted 2025/07/18 04:04:29.579050 WARN RESTY 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/CAuGR3A3MBpa3JdLdtk_HPdmqI9quOLiG81eAPNG6btISHXu2jGnjWc9CRNhvkVeP_IR9VLgKIuuk0AKAjjsew==/move: This value should not be blank. (Code=2000, Status=400), Attempt 1 2025/07/18 04:04:29.579077 ERROR RESTY 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/CAuGR3A3MBpa3JdLdtk_HPdmqI9quOLiG81eAPNG6btISHXu2jGnjWc9CRNhvkVeP_IR9VLgKIuuk0AKAjjsew==/move: This value should not be blank. (Code=2000, Status=400) 2025/07/18 04:04:29 ERROR : potato2: Couldn't move: 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/CAuGR3A3MBpa3JdLdtk_HPdmqI9quOLiG81eAPNG6btISHXu2jGnjWc9CRNhvkVeP_IR9VLgKIuuk0AKAjjsew==/move: This value should not be blank. (Code=2000, Status=400) 2025/07/18 04:04:29.731820 WARN RESTY 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/nE23zbZyjaU35Hb-N-3y32zQlcRc1tkwGH8Mnwf8jPfk7GRZkmMiAOvnTwn79xeBLeetOnIMBHGq3slm5iEmGA==/move: This value should not be blank. (Code=2000, Status=400), Attempt 1 2025/07/18 04:04:29.731851 ERROR RESTY 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/nE23zbZyjaU35Hb-N-3y32zQlcRc1tkwGH8Mnwf8jPfk7GRZkmMiAOvnTwn79xeBLeetOnIMBHGq3slm5iEmGA==/move: This value should not be blank. (Code=2000, Status=400) 2025/07/18 04:04:29 ERROR : potato3: Couldn't move: 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/nE23zbZyjaU35Hb-N-3y32zQlcRc1tkwGH8Mnwf8jPfk7GRZkmMiAOvnTwn79xeBLeetOnIMBHGq3slm5iEmGA==/move: This value should not be blank. (Code=2000, Status=400) 2025/07/18 04:04:29 ERROR : proton drive root link ID 'rclone-test-vikoced2piva': not deleting directories as there were IO errors sync_test.go:1746: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:1746 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:1931 Error: Received unexpected error: not deleting directories as there were IO errors Test: TestServerSideMoveDeleteEmptySourceDirs 2025/07/18 04:04:29 DEBUG : proton drive root link ID 'rclone-test-bewoxad2sati': Purge remote --- FAIL: TestServerSideMoveDeleteEmptySourceDirs (12.64s) === RUN TestSyncBackupDir run.go:180: Remote "proton drive root link ID 'rclone-test-vikoced2piva'", Local "Local file system at /tmp/rclone3627183167", Modify Window "1s" 2025/07/18 04:04:36 DEBUG : Creating backend with remote "TestProtonDrive:rclone-test-vikoced2piva/dst" 2025/07/18 04:04:36 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva/dst': Has cached credentials 2025/07/18 04:04:37 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva/dst': Used cached credential to initialize the ProtonDrive API 2025/07/18 04:05:52 DEBUG : Creating backend with remote "TestProtonDrive:rclone-test-vikoced2piva/backup" 2025/07/18 04:05:52 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva/backup': Has cached credentials 2025/07/18 04:05:53 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva/backup': Used cached credential to initialize the ProtonDrive API 2025/07/18 04:08:22 DEBUG : one: Sizes differ (src 4 vs dst 3) 2025/07/18 04:08:22 DEBUG : two: Size and modification time the same (differ by -499.999999ms, within tolerance 1s) 2025/07/18 04:08:22 DEBUG : two: Unchanged skipping 2025/07/18 04:08:22 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva/dst': Waiting for checks to finish 2025/07/18 04:08:23.350590 WARN RESTY 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/wc_PtQDdgwZiTPEZJ0XINCNTeW_s7VTJajk64PEQ-2fI6SHBg6SGhGRUA8NhD5O_hVsy9uYUt_37PKRFR3hSwQ==/move: This value should not be blank. (Code=2000, Status=400), Attempt 1 2025/07/18 04:08:23.350635 ERROR RESTY 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/wc_PtQDdgwZiTPEZJ0XINCNTeW_s7VTJajk64PEQ-2fI6SHBg6SGhGRUA8NhD5O_hVsy9uYUt_37PKRFR3hSwQ==/move: This value should not be blank. (Code=2000, Status=400) 2025/07/18 04:08:23 ERROR : one: Couldn't move: 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/wc_PtQDdgwZiTPEZJ0XINCNTeW_s7VTJajk64PEQ-2fI6SHBg6SGhGRUA8NhD5O_hVsy9uYUt_37PKRFR3hSwQ==/move: This value should not be blank. (Code=2000, Status=400) 2025/07/18 04:08:23 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva/dst': Waiting for transfers to finish 2025/07/18 04:08:23 ERROR : proton drive root link ID 'rclone-test-vikoced2piva/dst': not deleting files as there were IO errors 2025/07/18 04:08:23 ERROR : proton drive root link ID 'rclone-test-vikoced2piva/dst': not deleting directories as there were IO errors sync_test.go:2415: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2415 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2457 Error: Received unexpected error: 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/wc_PtQDdgwZiTPEZJ0XINCNTeW_s7VTJajk64PEQ-2fI6SHBg6SGhGRUA8NhD5O_hVsy9uYUt_37PKRFR3hSwQ==/move: This value should not be blank. (Code=2000, Status=400) Test: TestSyncBackupDir --- FAIL: TestSyncBackupDir (233.89s) === RUN TestSyncBackupDirWithSuffix run.go:180: Remote "proton drive root link ID 'rclone-test-vikoced2piva'", Local "Local file system at /tmp/rclone3627183167", Modify Window "1s" 2025/07/18 04:08:30 DEBUG : Creating backend with remote "TestProtonDrive:rclone-test-vikoced2piva/dst" 2025/07/18 04:08:30 DEBUG : Config file has changed externally - reloading 2025/07/18 04:08:30 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva/dst': Has cached credentials 2025/07/18 04:08:31 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva/dst': Used cached credential to initialize the ProtonDrive API 2025/07/18 04:09:44 DEBUG : Creating backend with remote "TestProtonDrive:rclone-test-vikoced2piva/backup" 2025/07/18 04:09:44 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva/backup': Has cached credentials 2025/07/18 04:09:45 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva/backup': Used cached credential to initialize the ProtonDrive API 2025/07/18 04:12:17 DEBUG : one: Sizes differ (src 4 vs dst 3) 2025/07/18 04:12:17 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva/dst': Waiting for checks to finish 2025/07/18 04:12:17 DEBUG : two: Size and modification time the same (differ by -499.999999ms, within tolerance 1s) 2025/07/18 04:12:17 DEBUG : two: Unchanged skipping 2025/07/18 04:12:17.994432 WARN RESTY 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/0e0s5yYHWhFK7koSK6I4kVZPcoNDvHrBdqorjqG7EhvGCxeVsgN6cJC6zUtAN-HGXLOrKESIDlh6RukX5w5TAg==/move: This value should not be blank. (Code=2000, Status=400), Attempt 1 2025/07/18 04:12:17.994529 ERROR RESTY 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/0e0s5yYHWhFK7koSK6I4kVZPcoNDvHrBdqorjqG7EhvGCxeVsgN6cJC6zUtAN-HGXLOrKESIDlh6RukX5w5TAg==/move: This value should not be blank. (Code=2000, Status=400) 2025/07/18 04:12:17 ERROR : one: Couldn't move: 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/0e0s5yYHWhFK7koSK6I4kVZPcoNDvHrBdqorjqG7EhvGCxeVsgN6cJC6zUtAN-HGXLOrKESIDlh6RukX5w5TAg==/move: This value should not be blank. (Code=2000, Status=400) 2025/07/18 04:12:17 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva/dst': Waiting for transfers to finish 2025/07/18 04:12:17 ERROR : proton drive root link ID 'rclone-test-vikoced2piva/dst': not deleting files as there were IO errors 2025/07/18 04:12:17 ERROR : proton drive root link ID 'rclone-test-vikoced2piva/dst': not deleting directories as there were IO errors sync_test.go:2415: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2415 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2461 Error: Received unexpected error: 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/0e0s5yYHWhFK7koSK6I4kVZPcoNDvHrBdqorjqG7EhvGCxeVsgN6cJC6zUtAN-HGXLOrKESIDlh6RukX5w5TAg==/move: This value should not be blank. (Code=2000, Status=400) Test: TestSyncBackupDirWithSuffix --- FAIL: TestSyncBackupDirWithSuffix (234.58s) === RUN TestSyncBackupDirWithSuffixKeepExtension run.go:180: Remote "proton drive root link ID 'rclone-test-vikoced2piva'", Local "Local file system at /tmp/rclone3627183167", Modify Window "1s" 2025/07/18 04:12:25 DEBUG : Creating backend with remote "TestProtonDrive:rclone-test-vikoced2piva/dst" 2025/07/18 04:12:25 DEBUG : Config file has changed externally - reloading 2025/07/18 04:12:25 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva/dst': Has cached credentials 2025/07/18 04:12:26 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva/dst': Used cached credential to initialize the ProtonDrive API 2025/07/18 04:13:42 DEBUG : Creating backend with remote "TestProtonDrive:rclone-test-vikoced2piva/backup" 2025/07/18 04:13:42 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva/backup': Has cached credentials 2025/07/18 04:13:43 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva/backup': Used cached credential to initialize the ProtonDrive API 2025/07/18 04:16:15 DEBUG : one: Sizes differ (src 4 vs dst 3) 2025/07/18 04:16:15 DEBUG : two: Size and modification time the same (differ by -499.999999ms, within tolerance 1s) 2025/07/18 04:16:15 DEBUG : two: Unchanged skipping 2025/07/18 04:16:15 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva/dst': Waiting for checks to finish 2025/07/18 04:16:16.124428 WARN RESTY 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/JOakKoFYPaCez8c6hjO8pZo02OipaxnVt0AJpWCbrvW59LdUTcqxb3RqRQUEQ0z_rr0MRzwRjekzyFxgoVRRtQ==/move: This value should not be blank. (Code=2000, Status=400), Attempt 1 2025/07/18 04:16:16.124464 ERROR RESTY 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/JOakKoFYPaCez8c6hjO8pZo02OipaxnVt0AJpWCbrvW59LdUTcqxb3RqRQUEQ0z_rr0MRzwRjekzyFxgoVRRtQ==/move: This value should not be blank. (Code=2000, Status=400) 2025/07/18 04:16:16 ERROR : one: Couldn't move: 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/JOakKoFYPaCez8c6hjO8pZo02OipaxnVt0AJpWCbrvW59LdUTcqxb3RqRQUEQ0z_rr0MRzwRjekzyFxgoVRRtQ==/move: This value should not be blank. (Code=2000, Status=400) 2025/07/18 04:16:16 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva/dst': Waiting for transfers to finish 2025/07/18 04:16:16 ERROR : proton drive root link ID 'rclone-test-vikoced2piva/dst': not deleting files as there were IO errors 2025/07/18 04:16:16 ERROR : proton drive root link ID 'rclone-test-vikoced2piva/dst': not deleting directories as there were IO errors sync_test.go:2415: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2415 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2465 Error: Received unexpected error: 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/JOakKoFYPaCez8c6hjO8pZo02OipaxnVt0AJpWCbrvW59LdUTcqxb3RqRQUEQ0z_rr0MRzwRjekzyFxgoVRRtQ==/move: This value should not be blank. (Code=2000, Status=400) Test: TestSyncBackupDirWithSuffixKeepExtension --- FAIL: TestSyncBackupDirWithSuffixKeepExtension (238.31s) === RUN TestSyncBackupDirSuffixOnly run.go:180: Remote "proton drive root link ID 'rclone-test-vikoced2piva'", Local "Local file system at /tmp/rclone3627183167", Modify Window "1s" 2025/07/18 04:16:23 DEBUG : Creating backend with remote "TestProtonDrive:rclone-test-vikoced2piva/dst" 2025/07/18 04:16:23 DEBUG : Config file has changed externally - reloading 2025/07/18 04:16:23 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva/dst': Has cached credentials 2025/07/18 04:16:24 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva/dst': Used cached credential to initialize the ProtonDrive API 2025/07/18 04:17:39 DEBUG : one: Sizes differ (src 4 vs dst 3) 2025/07/18 04:17:39 DEBUG : two: Size and modification time the same (differ by -499.999999ms, within tolerance 1s) 2025/07/18 04:17:39 DEBUG : two: Unchanged skipping 2025/07/18 04:17:39 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva/dst': Waiting for checks to finish 2025/07/18 04:17:40.175649 WARN RESTY 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/ekbJul7vv8y37sKArNmulN-bCWwldK63c7Kez1HuivUS3q6nWEVXPGamaLQtDAmOwhN24WtX2rgg0XVM1nEnSg==/move: This value should not be blank. (Code=2000, Status=400), Attempt 1 2025/07/18 04:17:40.175684 ERROR RESTY 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/ekbJul7vv8y37sKArNmulN-bCWwldK63c7Kez1HuivUS3q6nWEVXPGamaLQtDAmOwhN24WtX2rgg0XVM1nEnSg==/move: This value should not be blank. (Code=2000, Status=400) 2025/07/18 04:17:40 ERROR : one: Couldn't move: 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/ekbJul7vv8y37sKArNmulN-bCWwldK63c7Kez1HuivUS3q6nWEVXPGamaLQtDAmOwhN24WtX2rgg0XVM1nEnSg==/move: This value should not be blank. (Code=2000, Status=400) 2025/07/18 04:17:40 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva/dst': Waiting for transfers to finish 2025/07/18 04:17:40 ERROR : proton drive root link ID 'rclone-test-vikoced2piva/dst': not deleting files as there were IO errors 2025/07/18 04:17:40 ERROR : proton drive root link ID 'rclone-test-vikoced2piva/dst': not deleting directories as there were IO errors sync_test.go:2415: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2415 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2469 Error: Received unexpected error: 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/ekbJul7vv8y37sKArNmulN-bCWwldK63c7Kez1HuivUS3q6nWEVXPGamaLQtDAmOwhN24WtX2rgg0XVM1nEnSg==/move: This value should not be blank. (Code=2000, Status=400) Test: TestSyncBackupDirSuffixOnly --- FAIL: TestSyncBackupDirSuffixOnly (83.67s) === RUN TestSyncSuffix run.go:180: Remote "proton drive root link ID 'rclone-test-vikoced2piva'", Local "Local file system at /tmp/rclone3627183167", Modify Window "1s" 2025/07/18 04:17:47 DEBUG : Creating backend with remote "TestProtonDrive:rclone-test-vikoced2piva/dst" 2025/07/18 04:17:47 DEBUG : Config file has changed externally - reloading 2025/07/18 04:17:47 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva/dst': Has cached credentials 2025/07/18 04:17:48 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva/dst': Used cached credential to initialize the ProtonDrive API 2025/07/18 04:19:02 DEBUG : one: Sizes differ (src 4 vs dst 3) 2025/07/18 04:19:02.573626 WARN RESTY 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/MrNgEByQ0d9dTvlp4c-92FCo2XjqFdxb7ObjotbpLW2DrnDYPmWpO5NEhizwaWSCpPR7wAMfvMdCDQEBxYJBQw==/move: This value should not be blank. (Code=2000, Status=400), Attempt 1 2025/07/18 04:19:02.573653 ERROR RESTY 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/MrNgEByQ0d9dTvlp4c-92FCo2XjqFdxb7ObjotbpLW2DrnDYPmWpO5NEhizwaWSCpPR7wAMfvMdCDQEBxYJBQw==/move: This value should not be blank. (Code=2000, Status=400) 2025/07/18 04:19:02 ERROR : one: Couldn't move: 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/MrNgEByQ0d9dTvlp4c-92FCo2XjqFdxb7ObjotbpLW2DrnDYPmWpO5NEhizwaWSCpPR7wAMfvMdCDQEBxYJBQw==/move: This value should not be blank. (Code=2000, Status=400) sync_test.go:2503: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2503 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2553 Error: Received unexpected error: moving to --backup-dir failed: 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/MrNgEByQ0d9dTvlp4c-92FCo2XjqFdxb7ObjotbpLW2DrnDYPmWpO5NEhizwaWSCpPR7wAMfvMdCDQEBxYJBQw==/move: This value should not be blank. (Code=2000, Status=400) Test: TestSyncSuffix --- FAIL: TestSyncSuffix (82.36s) === RUN TestSyncSuffixKeepExtension run.go:180: Remote "proton drive root link ID 'rclone-test-vikoced2piva'", Local "Local file system at /tmp/rclone3627183167", Modify Window "1s" 2025/07/18 04:19:09 DEBUG : Creating backend with remote "TestProtonDrive:rclone-test-vikoced2piva/dst" 2025/07/18 04:19:09 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva/dst': Has cached credentials 2025/07/18 04:19:10 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva/dst': Used cached credential to initialize the ProtonDrive API 2025/07/18 04:20:21 DEBUG : one: Sizes differ (src 4 vs dst 3) 2025/07/18 04:20:21.552392 WARN RESTY 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/kNNAhlQUXo-COqyaSiBqJ3N2VkpBzHAhNlGNJ9qjDwDQjEPnDlAw_1BwKc_1cyBxml1W94gSokQyFlsfqjKvUg==/move: This value should not be blank. (Code=2000, Status=400), Attempt 1 2025/07/18 04:20:21.552445 ERROR RESTY 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/kNNAhlQUXo-COqyaSiBqJ3N2VkpBzHAhNlGNJ9qjDwDQjEPnDlAw_1BwKc_1cyBxml1W94gSokQyFlsfqjKvUg==/move: This value should not be blank. (Code=2000, Status=400) 2025/07/18 04:20:21 ERROR : one: Couldn't move: 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/kNNAhlQUXo-COqyaSiBqJ3N2VkpBzHAhNlGNJ9qjDwDQjEPnDlAw_1BwKc_1cyBxml1W94gSokQyFlsfqjKvUg==/move: This value should not be blank. (Code=2000, Status=400) sync_test.go:2503: Error Trace: /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2503 /home/rclone/go/src/github.com/rclone/rclone/fs/sync/sync_test.go:2554 Error: Received unexpected error: moving to --backup-dir failed: 400 PUT https://mail.proton.me/api/drive/shares/gYxulUP2_XOrbAxegpHKiBy09cfvss6mjykkd2Z3ZDpMFCmoWX4bC2TTm-Gl2UwrjReC8te_lFsQyeXT74Vgfw==/links/kNNAhlQUXo-COqyaSiBqJ3N2VkpBzHAhNlGNJ9qjDwDQjEPnDlAw_1BwKc_1cyBxml1W94gSokQyFlsfqjKvUg==/move: This value should not be blank. (Code=2000, Status=400) Test: TestSyncSuffixKeepExtension --- FAIL: TestSyncSuffixKeepExtension (78.99s) FAIL 2025/07/18 04:20:23 DEBUG : proton drive root link ID 'rclone-test-vikoced2piva': Purge remote "./sync.test -test.v -test.timeout 1h0m0s -remote TestProtonDrive: -verbose -test.run '^(TestMoveWithDeleteEmptySrcDirs|TestServerSideMove|TestServerSideMoveDeleteEmptySourceDirs|TestServerSideMoveOverSelf|TestServerSideMoveWithFilter|TestSyncBackupDir|TestSyncBackupDirSuffixOnly|TestSyncBackupDirWithSuffix|TestSyncBackupDirWithSuffixKeepExtension|TestSyncSuffix|TestSyncSuffixKeepExtension|TestSyncWithTrackRenames|TestSyncWithTrackRenamesStrategyLeaf|TestSyncWithTrackRenamesStrategyModtime)$'" - Finished ERROR in 17m5.352290779s (try 5/5): exit status 1: Failed [TestServerSideMoveOverSelf TestSyncWithTrackRenames TestSyncWithTrackRenamesStrategyModtime TestSyncWithTrackRenamesStrategyLeaf TestMoveWithDeleteEmptySrcDirs TestServerSideMove TestServerSideMoveWithFilter TestServerSideMoveDeleteEmptySourceDirs TestSyncBackupDir TestSyncBackupDirWithSuffix TestSyncBackupDirWithSuffixKeepExtension TestSyncBackupDirSuffixOnly TestSyncSuffix TestSyncSuffixKeepExtension]