"go test -v -timeout 1h0m0s -remote TestFTPPureftpd: -verbose" - Starting (try 1/5) === RUN TestIntegration fstests.go:438: Using remote "TestFTPPureftpd:" 2025/10/04 01:01:57 DEBUG : Creating backend with remote "TestFTPPureftpd:rclone-test-tusisud2hoqe" 2025/10/04 01:01:57 DEBUG : Using config file from "/home/rclone/.rclone.conf" 2025/10/04 01:01:57 DEBUG : Setting type="ftp" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_TYPE 2025/10/04 01:01:57 DEBUG : Setting host="172.17.0.5" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_HOST 2025/10/04 01:01:57 DEBUG : Setting user="rclone" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_USER 2025/10/04 01:01:57 DEBUG : Setting pass="2uVhIzhVfnAIN-2HibnJbDd_x4XH07hJret1mz--oec" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_PASS 2025/10/04 01:01:57 DEBUG : Setting encoding="BackSlash,Ctl,Del,Dot,RightSpace,Slash,SquareBracket" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_ENCODING 2025/10/04 01:01:57 DEBUG : TestFTPPureftpd: detected overridden config - adding "{0ueLh}" suffix to name 2025/10/04 01:01:57 DEBUG : Setting host="172.17.0.5" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_HOST 2025/10/04 01:01:57 DEBUG : Setting user="rclone" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_USER 2025/10/04 01:01:57 DEBUG : Setting pass="2uVhIzhVfnAIN-2HibnJbDd_x4XH07hJret1mz--oec" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_PASS 2025/10/04 01:01:57 DEBUG : Setting encoding="BackSlash,Ctl,Del,Dot,RightSpace,Slash,SquareBracket" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_ENCODING 2025/10/04 01:01:57 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: Connecting to FTP server 2025/10/04 01:01:57 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:21") 2025/10/04 01:01:57 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:37620->172.17.0.5:21, err= 2025/10/04 01:01:57 DEBUG : Setting type="ftp" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_TYPE === RUN TestIntegration/FsCheckWrap fstests.go:479: Not a wrapping Fs === RUN TestIntegration/FsCommand fstests.go:507: No commands in this remote === RUN TestIntegration/FsRmdirNotFound 2025/10/04 01:01:57 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:39194") 2025/10/04 01:01:57 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:41398->172.17.0.5:39194, err= === RUN TestIntegration/FsString === RUN TestIntegration/FsName === RUN TestIntegration/FsRoot === RUN TestIntegration/FsRmdirEmpty === RUN TestIntegration/FsMkdir 2025/10/04 01:01:57 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:37876") 2025/10/04 01:01:57 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:42108->172.17.0.5:37876, err= === RUN TestIntegration/FsMkdir/FsMkdirRmdirSubdir 2025/10/04 01:01:57 INFO : dir/subdir: Making directory 2025/10/04 01:01:57 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:30347") 2025/10/04 01:01:57 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:41790->172.17.0.5:30347, err= 2025/10/04 01:01:57 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:39295") 2025/10/04 01:01:57 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:36226->172.17.0.5:39295, err= 2025/10/04 01:01:57 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:32331") 2025/10/04 01:01:57 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:41602->172.17.0.5:32331, err= 2025/10/04 01:01:57 INFO : dir/subdir: Removing directory 2025/10/04 01:01:57 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:35162") 2025/10/04 01:01:57 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:52502->172.17.0.5:35162, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:31183") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:50104->172.17.0.5:31183, err= 2025/10/04 01:01:58 INFO : dir: Removing directory 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:30811") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:33380->172.17.0.5:30811, err= === RUN TestIntegration/FsMkdir/FsListEmpty 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:37404") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:42586->172.17.0.5:37404, err= === RUN TestIntegration/FsMkdir/FsListDirEmpty 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:39810") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:50350->172.17.0.5:39810, err= === RUN TestIntegration/FsMkdir/FsListRDirEmpty fstests.go:399: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsListDirNotFound 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:34772") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:48172->172.17.0.5:34772, err= 2025/10/04 01:01:58 ERROR : does not exist: error listing: directory not found === RUN TestIntegration/FsMkdir/FsListRDirNotFound fstests.go:399: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsEncoding 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:33702") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:44336->172.17.0.5:33702, err= === RUN TestIntegration/FsMkdir/FsEncoding/control_chars fstests.go:707: testing "␀␁␂␃␄␅␆␇␈␉␊␋␌␍␎␏␐␑␒␓␔␕␖␗␘␙␚␛␜␝␞␟␡" 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:32015") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:39860->172.17.0.5:32015, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:30084") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:50906->172.17.0.5:30084, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:35057") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:35566->172.17.0.5:35057, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:30561") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:38506->172.17.0.5:30561, err= === RUN TestIntegration/FsMkdir/FsEncoding/dot fstests.go:707: testing "." 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:37685") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:45902->172.17.0.5:37685, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:35313") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:45986->172.17.0.5:35313, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:37656") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:42508->172.17.0.5:37656, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:37447") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:49136->172.17.0.5:37447, err= === RUN TestIntegration/FsMkdir/FsEncoding/dot_dot fstests.go:707: testing ".." 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:34445") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:41848->172.17.0.5:34445, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:30985") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:47430->172.17.0.5:30985, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:33512") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:45206->172.17.0.5:33512, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:36533") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:35696->172.17.0.5:36533, err= === RUN TestIntegration/FsMkdir/FsEncoding/punctuation fstests.go:707: testing "!\"#$%&'()*+,-./:;<=>?@[\\]^_`{|}~" 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:33008") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:55800->172.17.0.5:33008, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:31691") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:56776->172.17.0.5:31691, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:38183") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:51950->172.17.0.5:38183, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:33714") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:38788->172.17.0.5:33714, err= === RUN TestIntegration/FsMkdir/FsEncoding/leading_space fstests.go:707: testing " leading space" 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:36315") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:35826->172.17.0.5:36315, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:36036") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:35014->172.17.0.5:36036, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:34630") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:45700->172.17.0.5:34630, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:30172") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:35118->172.17.0.5:30172, err= === RUN TestIntegration/FsMkdir/FsEncoding/leading_tilde fstests.go:707: testing "~leading tilde" 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:30080") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:47348->172.17.0.5:30080, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:32988") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:39932->172.17.0.5:32988, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:33897") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:60068->172.17.0.5:33897, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:37626") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:54800->172.17.0.5:37626, err= === RUN TestIntegration/FsMkdir/FsEncoding/leading_CR fstests.go:707: testing "␍leading CR" 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:37829") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:56332->172.17.0.5:37829, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:35217") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:56800->172.17.0.5:35217, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:34337") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:47782->172.17.0.5:34337, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:39573") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:57924->172.17.0.5:39573, err= === RUN TestIntegration/FsMkdir/FsEncoding/leading_LF fstests.go:707: testing "␊leading LF" 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:32527") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:49412->172.17.0.5:32527, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:38694") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:51814->172.17.0.5:38694, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:38819") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:55886->172.17.0.5:38819, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:39572") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:41144->172.17.0.5:39572, err= === RUN TestIntegration/FsMkdir/FsEncoding/leading_HT fstests.go:707: testing "␉leading HT" 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:35769") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:37286->172.17.0.5:35769, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:37950") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:47600->172.17.0.5:37950, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:32400") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:46428->172.17.0.5:32400, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:35893") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:43238->172.17.0.5:35893, err= === RUN TestIntegration/FsMkdir/FsEncoding/leading_VT fstests.go:707: testing "␋leading VT" 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:31395") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:54158->172.17.0.5:31395, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:32916") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:36130->172.17.0.5:32916, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:35799") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:53034->172.17.0.5:35799, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:32124") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:55088->172.17.0.5:32124, err= === RUN TestIntegration/FsMkdir/FsEncoding/leading_dot fstests.go:707: testing ".leading dot" 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:31553") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:56608->172.17.0.5:31553, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:33651") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:35266->172.17.0.5:33651, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:31076") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:39372->172.17.0.5:31076, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:33053") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:41088->172.17.0.5:33053, err= === RUN TestIntegration/FsMkdir/FsEncoding/trailing_space fstests.go:707: testing "trailing space " 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:34651") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:49900->172.17.0.5:34651, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:31790") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:47650->172.17.0.5:31790, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:33058") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:51882->172.17.0.5:33058, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:33593") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:50024->172.17.0.5:33593, err= === RUN TestIntegration/FsMkdir/FsEncoding/trailing_CR fstests.go:707: testing "trailing CR␍" 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:31035") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:52464->172.17.0.5:31035, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:31545") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:51702->172.17.0.5:31545, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:34855") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:60002->172.17.0.5:34855, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:39609") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:42490->172.17.0.5:39609, err= === RUN TestIntegration/FsMkdir/FsEncoding/trailing_LF fstests.go:707: testing "trailing LF␊" 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:30857") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:60436->172.17.0.5:30857, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:38729") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:58222->172.17.0.5:38729, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:38033") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:57004->172.17.0.5:38033, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:31321") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:45108->172.17.0.5:31321, err= === RUN TestIntegration/FsMkdir/FsEncoding/trailing_HT fstests.go:707: testing "trailing HT␉" 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:37604") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:53256->172.17.0.5:37604, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:33703") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:35560->172.17.0.5:33703, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:33554") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:32926->172.17.0.5:33554, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:38884") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:41684->172.17.0.5:38884, err= === RUN TestIntegration/FsMkdir/FsEncoding/trailing_VT fstests.go:707: testing "trailing VT␋" 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:34624") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:43346->172.17.0.5:34624, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:38329") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:58550->172.17.0.5:38329, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:32142") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:39132->172.17.0.5:32142, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:38628") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:57352->172.17.0.5:38628, err= === RUN TestIntegration/FsMkdir/FsEncoding/trailing_dot fstests.go:707: testing "trailing dot." 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:32995") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:57060->172.17.0.5:32995, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:35822") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:52790->172.17.0.5:35822, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:32100") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:55358->172.17.0.5:32100, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:31704") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:40456->172.17.0.5:31704, err= === RUN TestIntegration/FsMkdir/FsEncoding/invalid_UTF-8 fstests.go:707: testing "invalid utf-8\xfe" 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:39610") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:56136->172.17.0.5:39610, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:34690") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:42900->172.17.0.5:34690, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:34564") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:55422->172.17.0.5:34564, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:37264") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:40262->172.17.0.5:37264, err= === RUN TestIntegration/FsMkdir/FsEncoding/URL_encoding fstests.go:707: testing "test%46.txt" 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:36000") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:56770->172.17.0.5:36000, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:38358") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:48824->172.17.0.5:38358, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:36233") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:59882->172.17.0.5:36233, err= 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:32401") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:35604->172.17.0.5:32401, err= === RUN TestIntegration/FsMkdir/FsNewObjectNotFound === RUN TestIntegration/FsMkdir/FsPutError 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:36654") 2025/10/04 01:01:58 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:45946->172.17.0.5:36654, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: Connecting to FTP server 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:21") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:37636->172.17.0.5:21, err= 2025/10/04 01:01:59 DEBUG : hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: Removed after failed upload: 1 error occurred: * potato === RUN TestIntegration/FsMkdir/FsPutZeroLength 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:38747") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:49596->172.17.0.5:38747, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:30810") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:40484->172.17.0.5:30810, err= === RUN TestIntegration/FsMkdir/FsOpenWriterAt fstests.go:786: FS has no OpenWriterAt interface === RUN TestIntegration/FsMkdir/FsOpenChunkWriter fstests.go:819: FS has no OpenChunkWriter interface === RUN TestIntegration/FsMkdir/FsChangeNotify fstests.go:868: FS has no ChangeNotify interface === RUN TestIntegration/FsMkdir/FsPutFiles 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:38128") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:40572->172.17.0.5:38128, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:32015") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:39862->172.17.0.5:32015, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:34880") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:42334->172.17.0.5:34880, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsListDirFile2 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:30056") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:48568->172.17.0.5:30056, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:39004") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:38208->172.17.0.5:39004, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:34908") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:47312->172.17.0.5:34908, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:30816") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:44048->172.17.0.5:30816, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:30972") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:36412->172.17.0.5:30972, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsListRDirFile2 fstests.go:399: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsPutFiles/FsListR 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:35609") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:49550->172.17.0.5:35609, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:34926") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:55914->172.17.0.5:34926, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:39933") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:55942->172.17.0.5:39933, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:32357") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:57586->172.17.0.5:32357, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:38893") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:41246->172.17.0.5:38893, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsListRSubdir 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:33536") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:51400->172.17.0.5:33536, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:32057") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:49120->172.17.0.5:32057, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:37447") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:49138->172.17.0.5:37447, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:30956") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:57504->172.17.0.5:30956, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsListDirRoot 2025/10/04 01:01:59 DEBUG : Creating backend with remote "TestFTPPureftpd:" 2025/10/04 01:01:59 DEBUG : Setting type="ftp" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_TYPE 2025/10/04 01:01:59 DEBUG : Setting host="172.17.0.5" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_HOST 2025/10/04 01:01:59 DEBUG : Setting user="rclone" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_USER 2025/10/04 01:01:59 DEBUG : Setting pass="2uVhIzhVfnAIN-2HibnJbDd_x4XH07hJret1mz--oec" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_PASS 2025/10/04 01:01:59 DEBUG : Setting encoding="BackSlash,Ctl,Del,Dot,RightSpace,Slash,SquareBracket" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_ENCODING 2025/10/04 01:01:59 DEBUG : TestFTPPureftpd: detected overridden config - adding "{0ueLh}" suffix to name 2025/10/04 01:01:59 DEBUG : Setting host="172.17.0.5" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_HOST 2025/10/04 01:01:59 DEBUG : Setting user="rclone" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_USER 2025/10/04 01:01:59 DEBUG : Setting pass="2uVhIzhVfnAIN-2HibnJbDd_x4XH07hJret1mz--oec" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_PASS 2025/10/04 01:01:59 DEBUG : Setting encoding="BackSlash,Ctl,Del,Dot,RightSpace,Slash,SquareBracket" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_ENCODING 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: Connecting to FTP server 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: dial("tcp","172.17.0.5:21") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: > dial: conn=172.17.0.1:37648->172.17.0.5:21, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: dial("tcp","172.17.0.5:32282") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: > dial: conn=172.17.0.1:34776->172.17.0.5:32282, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsListRDirRoot fstests.go:399: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsPutFiles/FsListSubdir 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:39379") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:38810->172.17.0.5:39379, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:38824") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:43610->172.17.0.5:38824, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsListRSubdir#01 fstests.go:399: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsPutFiles/FsListLevel2 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:39491") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:42600->172.17.0.5:39491, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:34220") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:51318->172.17.0.5:34220, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsListRLevel2 fstests.go:399: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsPutFiles/FsListFile1 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:34529") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:50130->172.17.0.5:34529, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:37407") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:56096->172.17.0.5:37407, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:37403") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:54808->172.17.0.5:37403, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:39129") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:54546->172.17.0.5:39129, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:38222") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:51844->172.17.0.5:38222, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsNewObject === RUN TestIntegration/FsMkdir/FsPutFiles/FsNewObjectCaseInsensitive fstests.go:1121: Not Case Insensitive === RUN TestIntegration/FsMkdir/FsPutFiles/FsListFile1and2 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:38572") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:42326->172.17.0.5:38572, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:35335") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:35768->172.17.0.5:35335, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:34566") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:60328->172.17.0.5:34566, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:39134") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:48498->172.17.0.5:39134, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:34633") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:44900->172.17.0.5:34633, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsNewObjectDir === RUN TestIntegration/FsMkdir/FsPutFiles/FsPurge fstests.go:1153: FS has no Purge interface === RUN TestIntegration/FsMkdir/FsPutFiles/FsPurgeRoot fstests.go:1190: FS has no Purge interface === RUN TestIntegration/FsMkdir/FsPutFiles/FsListRootedSubdir 2025/10/04 01:01:59 DEBUG : Creating backend with remote "TestFTPPureftpd:rclone-test-tusisud2hoqe/hello? sausage/êé" 2025/10/04 01:01:59 DEBUG : Setting type="ftp" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_TYPE 2025/10/04 01:01:59 DEBUG : Setting host="172.17.0.5" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_HOST 2025/10/04 01:01:59 DEBUG : Setting user="rclone" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_USER 2025/10/04 01:01:59 DEBUG : Setting pass="2uVhIzhVfnAIN-2HibnJbDd_x4XH07hJret1mz--oec" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_PASS 2025/10/04 01:01:59 DEBUG : Setting encoding="BackSlash,Ctl,Del,Dot,RightSpace,Slash,SquareBracket" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_ENCODING 2025/10/04 01:01:59 DEBUG : TestFTPPureftpd: detected overridden config - adding "{0ueLh}" suffix to name 2025/10/04 01:01:59 DEBUG : Setting host="172.17.0.5" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_HOST 2025/10/04 01:01:59 DEBUG : Setting user="rclone" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_USER 2025/10/04 01:01:59 DEBUG : Setting pass="2uVhIzhVfnAIN-2HibnJbDd_x4XH07hJret1mz--oec" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_PASS 2025/10/04 01:01:59 DEBUG : Setting encoding="BackSlash,Ctl,Del,Dot,RightSpace,Slash,SquareBracket" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_ENCODING 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: Connecting to FTP server 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: dial("tcp","172.17.0.5:21") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: > dial: conn=172.17.0.1:37658->172.17.0.5:21, err= 2025/10/04 01:01:59 DEBUG : fs cache: renaming cache item "TestFTPPureftpd:rclone-test-tusisud2hoqe/hello? sausage/êé" to be canonical "TestFTPPureftpd{0ueLh}:rclone-test-tusisud2hoqe/hello? sausage/êé" 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: dial("tcp","172.17.0.5:38745") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: > dial: conn=172.17.0.1:39736->172.17.0.5:38745, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: dial("tcp","172.17.0.5:39370") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: > dial: conn=172.17.0.1:56224->172.17.0.5:39370, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: Connecting to FTP server 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: dial("tcp","172.17.0.5:21") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: > dial: conn=172.17.0.1:37674->172.17.0.5:21, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: dial("tcp","172.17.0.5:33625") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: > dial: conn=172.17.0.1:53206->172.17.0.5:33625, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: dial("tcp","172.17.0.5:36514") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: > dial: conn=172.17.0.1:60314->172.17.0.5:36514, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: dial("tcp","172.17.0.5:30582") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: > dial: conn=172.17.0.1:57168->172.17.0.5:30582, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: dial("tcp","172.17.0.5:30244") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: > dial: conn=172.17.0.1:53354->172.17.0.5:30244, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: dial("tcp","172.17.0.5:34328") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: > dial: conn=172.17.0.1:59956->172.17.0.5:34328, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: dial("tcp","172.17.0.5:36822") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: > dial: conn=172.17.0.1:37614->172.17.0.5:36822, err= 2025/10/04 01:01:59 DEBUG : Waiting for deletions to finish 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: dial("tcp","172.17.0.5:32718") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: > dial: conn=172.17.0.1:33890->172.17.0.5:32718, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: dial("tcp","172.17.0.5:37648") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: > dial: conn=172.17.0.1:60668->172.17.0.5:37648, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: dial("tcp","172.17.0.5:39936") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: > dial: conn=172.17.0.1:40280->172.17.0.5:39936, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: dial("tcp","172.17.0.5:37899") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: > dial: conn=172.17.0.1:56886->172.17.0.5:37899, err= 2025/10/04 01:01:59 INFO : a/b/c/d/e.txt: Deleted 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: dial("tcp","172.17.0.5:39133") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: > dial: conn=172.17.0.1:56748->172.17.0.5:39133, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: dial("tcp","172.17.0.5:34889") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: > dial: conn=172.17.0.1:35170->172.17.0.5:34889, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: dial("tcp","172.17.0.5:35469") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: > dial: conn=172.17.0.1:35504->172.17.0.5:35469, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: dial("tcp","172.17.0.5:35608") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé: > dial: conn=172.17.0.1:35412->172.17.0.5:35608, err= 2025/10/04 01:01:59 DEBUG : removing 1 level 4 directories 2025/10/04 01:01:59 INFO : a/b/c/d: Removing directory 2025/10/04 01:01:59 DEBUG : removing 1 level 3 directories 2025/10/04 01:01:59 INFO : a/b/c: Removing directory 2025/10/04 01:01:59 DEBUG : removing 1 level 2 directories 2025/10/04 01:01:59 INFO : a/b: Removing directory 2025/10/04 01:01:59 DEBUG : removing 1 level 1 directories 2025/10/04 01:01:59 INFO : a: Removing directory === RUN TestIntegration/FsMkdir/FsPutFiles/FsCopy fstests.go:1254: FS has no Copier interface === RUN TestIntegration/FsMkdir/FsPutFiles/FsMove 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:38968") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:41060->172.17.0.5:38968, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:39614") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:55834->172.17.0.5:39614, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:34815") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:50702->172.17.0.5:34815, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:38568") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:54512->172.17.0.5:38568, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:34675") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:41562->172.17.0.5:34675, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:39378") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:37122->172.17.0.5:39378, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: Connecting to FTP server 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:21") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:37676->172.17.0.5:21, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:33677") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:59990->172.17.0.5:33677, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:36417") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:57884->172.17.0.5:36417, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:38339") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:39432->172.17.0.5:38339, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:30822") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:55606->172.17.0.5:30822, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:38540") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:55038->172.17.0.5:38540, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:32682") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:41286->172.17.0.5:32682, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:30194") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:32997") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:34934->172.17.0.5:30194, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:49068->172.17.0.5:32997, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:38937") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:55254->172.17.0.5:38937, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:30384") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:43698->172.17.0.5:30384, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:36699") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:38528->172.17.0.5:36699, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:31083") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:41022->172.17.0.5:31083, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:38340") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:36158") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:53940->172.17.0.5:36158, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:59800->172.17.0.5:38340, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:32078") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:48602->172.17.0.5:32078, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:30515") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:56134->172.17.0.5:30515, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:34466") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:42640->172.17.0.5:34466, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsMove/Metadata fstests.go:1398: Skipping test as can't write metadata === RUN TestIntegration/FsMkdir/FsPutFiles/FsDirMove 2025/10/04 01:01:59 DEBUG : Creating backend with remote "TestFTPPureftpd:rclone-test-cofiqan7ropo" 2025/10/04 01:01:59 DEBUG : Setting type="ftp" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_TYPE 2025/10/04 01:01:59 DEBUG : Setting host="172.17.0.5" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_HOST 2025/10/04 01:01:59 DEBUG : Setting user="rclone" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_USER 2025/10/04 01:01:59 DEBUG : Setting pass="2uVhIzhVfnAIN-2HibnJbDd_x4XH07hJret1mz--oec" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_PASS 2025/10/04 01:01:59 DEBUG : Setting encoding="BackSlash,Ctl,Del,Dot,RightSpace,Slash,SquareBracket" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_ENCODING 2025/10/04 01:01:59 DEBUG : TestFTPPureftpd: detected overridden config - adding "{0ueLh}" suffix to name 2025/10/04 01:01:59 DEBUG : Setting host="172.17.0.5" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_HOST 2025/10/04 01:01:59 DEBUG : Setting user="rclone" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_USER 2025/10/04 01:01:59 DEBUG : Setting pass="2uVhIzhVfnAIN-2HibnJbDd_x4XH07hJret1mz--oec" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_PASS 2025/10/04 01:01:59 DEBUG : Setting encoding="BackSlash,Ctl,Del,Dot,RightSpace,Slash,SquareBracket" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_ENCODING 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-cofiqan7ropo: Connecting to FTP server 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-cofiqan7ropo: dial("tcp","172.17.0.5:21") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-cofiqan7ropo: > dial: conn=172.17.0.1:37680->172.17.0.5:21, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:33246") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:52314->172.17.0.5:33246, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-cofiqan7ropo: dial("tcp","172.17.0.5:37939") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-cofiqan7ropo: > dial: conn=172.17.0.1:49468->172.17.0.5:37939, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-cofiqan7ropo: dial("tcp","172.17.0.5:38349") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-cofiqan7ropo: > dial: conn=172.17.0.1:54608->172.17.0.5:38349, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-cofiqan7ropo: dial("tcp","172.17.0.5:37887") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-cofiqan7ropo: > dial: conn=172.17.0.1:51014->172.17.0.5:37887, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-cofiqan7ropo: dial("tcp","172.17.0.5:35034") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-cofiqan7ropo: > dial: conn=172.17.0.1:52858->172.17.0.5:35034, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-cofiqan7ropo: dial("tcp","172.17.0.5:37478") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-cofiqan7ropo: > dial: conn=172.17.0.1:60182->172.17.0.5:37478, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-cofiqan7ropo: dial("tcp","172.17.0.5:33968") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-cofiqan7ropo: > dial: conn=172.17.0.1:51408->172.17.0.5:33968, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-cofiqan7ropo: dial("tcp","172.17.0.5:35698") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-cofiqan7ropo: > dial: conn=172.17.0.1:56260->172.17.0.5:35698, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:35388") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:34006->172.17.0.5:35388, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:38382") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:59972->172.17.0.5:38382, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:34169") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:48372->172.17.0.5:34169, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:30059") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:43514->172.17.0.5:30059, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:38014") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:33524->172.17.0.5:38014, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-cofiqan7ropo: dial("tcp","172.17.0.5:33584") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-cofiqan7ropo: > dial: conn=172.17.0.1:44614->172.17.0.5:33584, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-cofiqan7ropo: dial("tcp","172.17.0.5:34934") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-cofiqan7ropo: > dial: conn=172.17.0.1:45484->172.17.0.5:34934, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-cofiqan7ropo: dial("tcp","172.17.0.5:37528") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-cofiqan7ropo: > dial: conn=172.17.0.1:60612->172.17.0.5:37528, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-cofiqan7ropo: dial("tcp","172.17.0.5:30131") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-cofiqan7ropo: > dial: conn=172.17.0.1:47084->172.17.0.5:30131, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-cofiqan7ropo: Purge dir "new_name" 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-cofiqan7ropo: Purge dir "" === RUN TestIntegration/FsMkdir/FsPutFiles/FsRmdirFull === RUN TestIntegration/FsMkdir/FsPutFiles/FsPrecision === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectString === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectFs === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectRemote === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectHashes === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectModTime === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectMimeType fstests.go:1592: MimeType method not supported === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectMetadata fstests.go:1623: Metadata method not supported === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectSetMetadata fstests.go:1694: SetMetadata method not supported === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectSetModTime === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectSize === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectOpen 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:32574") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:37236->172.17.0.5:32574, err= === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectOpenSeek 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:39562") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:57416->172.17.0.5:39562, err= === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectOpenRange 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:34007") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:50072->172.17.0.5:34007, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:38783") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:47736->172.17.0.5:38783, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:31393") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:44034->172.17.0.5:31393, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:30825") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:54290->172.17.0.5:30825, err= === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectPartialRead 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:30110") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:33498->172.17.0.5:30110, err= === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectUpdate 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:38527") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:57038->172.17.0.5:38527, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:37603") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:49720->172.17.0.5:37603, err= === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectStorable === RUN TestIntegration/FsMkdir/FsPutFiles/FsIsFile 2025/10/04 01:01:59 DEBUG : Creating backend with remote "TestFTPPureftpd:rclone-test-tusisud2hoqe/hello? sausage/êé/Hello, 世界/ \" ' @ < > & ? + ≠/z.txt" 2025/10/04 01:01:59 DEBUG : Setting type="ftp" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_TYPE 2025/10/04 01:01:59 DEBUG : Setting host="172.17.0.5" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_HOST 2025/10/04 01:01:59 DEBUG : Setting user="rclone" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_USER 2025/10/04 01:01:59 DEBUG : Setting pass="2uVhIzhVfnAIN-2HibnJbDd_x4XH07hJret1mz--oec" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_PASS 2025/10/04 01:01:59 DEBUG : Setting encoding="BackSlash,Ctl,Del,Dot,RightSpace,Slash,SquareBracket" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_ENCODING 2025/10/04 01:01:59 DEBUG : TestFTPPureftpd: detected overridden config - adding "{0ueLh}" suffix to name 2025/10/04 01:01:59 DEBUG : Setting host="172.17.0.5" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_HOST 2025/10/04 01:01:59 DEBUG : Setting user="rclone" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_USER 2025/10/04 01:01:59 DEBUG : Setting pass="2uVhIzhVfnAIN-2HibnJbDd_x4XH07hJret1mz--oec" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_PASS 2025/10/04 01:01:59 DEBUG : Setting encoding="BackSlash,Ctl,Del,Dot,RightSpace,Slash,SquareBracket" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_ENCODING 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: Connecting to FTP server 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: dial("tcp","172.17.0.5:21") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: > dial: conn=172.17.0.1:37682->172.17.0.5:21, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsIsFile/FsRoot 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: dial("tcp","172.17.0.5:32105") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: > dial: conn=172.17.0.1:45032->172.17.0.5:32105, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsIsFileNotFound 2025/10/04 01:01:59 DEBUG : Creating backend with remote "TestFTPPureftpd:rclone-test-tusisud2hoqe/not found.txt" 2025/10/04 01:01:59 DEBUG : Setting type="ftp" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_TYPE 2025/10/04 01:01:59 DEBUG : Setting host="172.17.0.5" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_HOST 2025/10/04 01:01:59 DEBUG : Setting user="rclone" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_USER 2025/10/04 01:01:59 DEBUG : Setting pass="2uVhIzhVfnAIN-2HibnJbDd_x4XH07hJret1mz--oec" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_PASS 2025/10/04 01:01:59 DEBUG : Setting encoding="BackSlash,Ctl,Del,Dot,RightSpace,Slash,SquareBracket" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_ENCODING 2025/10/04 01:01:59 DEBUG : TestFTPPureftpd: detected overridden config - adding "{0ueLh}" suffix to name 2025/10/04 01:01:59 DEBUG : Setting host="172.17.0.5" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_HOST 2025/10/04 01:01:59 DEBUG : Setting user="rclone" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_USER 2025/10/04 01:01:59 DEBUG : Setting pass="2uVhIzhVfnAIN-2HibnJbDd_x4XH07hJret1mz--oec" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_PASS 2025/10/04 01:01:59 DEBUG : Setting encoding="BackSlash,Ctl,Del,Dot,RightSpace,Slash,SquareBracket" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_ENCODING 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/not found.txt: Connecting to FTP server 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/not found.txt: dial("tcp","172.17.0.5:21") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/not found.txt: > dial: conn=172.17.0.1:37686->172.17.0.5:21, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/not found.txt: dial("tcp","172.17.0.5:36713") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/not found.txt: > dial: conn=172.17.0.1:47932->172.17.0.5:36713, err= 2025/10/04 01:01:59 ERROR : error listing: directory not found === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot fstests.go:1911: Opening root remote "TestFTPPureftpd:" path "rclone-test-tusisud2hoqe" from "TestFTPPureftpd:rclone-test-tusisud2hoqe" 2025/10/04 01:01:59 DEBUG : Creating backend with remote "TestFTPPureftpd:" 2025/10/04 01:01:59 DEBUG : Setting type="ftp" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_TYPE 2025/10/04 01:01:59 DEBUG : Setting host="172.17.0.5" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_HOST 2025/10/04 01:01:59 DEBUG : Setting user="rclone" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_USER 2025/10/04 01:01:59 DEBUG : Setting pass="2uVhIzhVfnAIN-2HibnJbDd_x4XH07hJret1mz--oec" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_PASS 2025/10/04 01:01:59 DEBUG : Setting encoding="BackSlash,Ctl,Del,Dot,RightSpace,Slash,SquareBracket" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_ENCODING 2025/10/04 01:01:59 DEBUG : TestFTPPureftpd: detected overridden config - adding "{0ueLh}" suffix to name 2025/10/04 01:01:59 DEBUG : Setting host="172.17.0.5" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_HOST 2025/10/04 01:01:59 DEBUG : Setting user="rclone" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_USER 2025/10/04 01:01:59 DEBUG : Setting pass="2uVhIzhVfnAIN-2HibnJbDd_x4XH07hJret1mz--oec" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_PASS 2025/10/04 01:01:59 DEBUG : Setting encoding="BackSlash,Ctl,Del,Dot,RightSpace,Slash,SquareBracket" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_ENCODING 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: Connecting to FTP server 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: dial("tcp","172.17.0.5:21") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: > dial: conn=172.17.0.1:37690->172.17.0.5:21, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot/List 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: dial("tcp","172.17.0.5:37952") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: > dial: conn=172.17.0.1:46076->172.17.0.5:37952, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: dial("tcp","172.17.0.5:34394") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: > dial: conn=172.17.0.1:54480->172.17.0.5:34394, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: dial("tcp","172.17.0.5:34282") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: > dial: conn=172.17.0.1:42820->172.17.0.5:34282, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: dial("tcp","172.17.0.5:37963") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: > dial: conn=172.17.0.1:42846->172.17.0.5:37963, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: dial("tcp","172.17.0.5:35634") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: > dial: conn=172.17.0.1:56680->172.17.0.5:35634, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot/ListEntries 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: dial("tcp","172.17.0.5:37634") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: > dial: conn=172.17.0.1:60286->172.17.0.5:37634, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot/ListR fstests.go:1945: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot/Put 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: dial("tcp","172.17.0.5:38420") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: > dial: conn=172.17.0.1:50296->172.17.0.5:38420, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: dial("tcp","172.17.0.5:38001") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: > dial: conn=172.17.0.1:37880->172.17.0.5:38001, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: dial("tcp","172.17.0.5:38157") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: > dial: conn=172.17.0.1:36240->172.17.0.5:38157, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: dial("tcp","172.17.0.5:37580") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: > dial: conn=172.17.0.1:48874->172.17.0.5:37580, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: dial("tcp","172.17.0.5:32281") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: > dial: conn=172.17.0.1:42500->172.17.0.5:32281, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: dial("tcp","172.17.0.5:37407") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: > dial: conn=172.17.0.1:56108->172.17.0.5:37407, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot/Put/Remove 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: dial("tcp","172.17.0.5:33943") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: > dial: conn=172.17.0.1:59800->172.17.0.5:33943, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: dial("tcp","172.17.0.5:34922") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: > dial: conn=172.17.0.1:59950->172.17.0.5:34922, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: dial("tcp","172.17.0.5:37647") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: > dial: conn=172.17.0.1:58080->172.17.0.5:37647, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: dial("tcp","172.17.0.5:38399") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: > dial: conn=172.17.0.1:53598->172.17.0.5:38399, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: dial("tcp","172.17.0.5:34470") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21: > dial: conn=172.17.0.1:36320->172.17.0.5:34470, err= === RUN TestIntegration/FsMkdir/FsPutFiles/PublicLink fstests.go:2004: FS has no PublicLinker interface === RUN TestIntegration/FsMkdir/FsPutFiles/SetTier fstests.go:412: FS has no SetTier & GetTier interfaces === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectCheckWrap fstests.go:2109: Not a wrapping Fs === RUN TestIntegration/FsMkdir/FsPutFiles/Bucket fstests.go:2125: Not a bucket based backend === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectRemove 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:30261") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:51646->172.17.0.5:30261, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:38562") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:53216->172.17.0.5:38562, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:30223") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:50646->172.17.0.5:30223, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:37176") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:34736->172.17.0.5:37176, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:33447") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:38936->172.17.0.5:33447, err= === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectAbout fstests.go:2281: FS does not support About === RUN TestIntegration/FsMkdir/FsPutFiles/FsPutStream === RUN TestIntegration/FsMkdir/FsPutFiles/FsPutStream/0 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:33002") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:52808->172.17.0.5:33002, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsPutStream/100 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:39470") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:45108->172.17.0.5:39470, err= === RUN TestIntegration/FsMkdir/FsPutFiles/Internal === RUN TestIntegration/FsMkdir/FsPutFiles/Internal/UploadTimeout 2025/10/04 01:01:59 DEBUG : Creating backend with remote "TestFTPPureftpd,concurrency='0',shut_timeout='1s':rclone-test-tusisud2hoqe" 2025/10/04 01:01:59 DEBUG : Setting type="ftp" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_TYPE 2025/10/04 01:01:59 DEBUG : Setting host="172.17.0.5" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_HOST 2025/10/04 01:01:59 DEBUG : Setting user="rclone" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_USER 2025/10/04 01:01:59 DEBUG : Setting pass="2uVhIzhVfnAIN-2HibnJbDd_x4XH07hJret1mz--oec" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_PASS 2025/10/04 01:01:59 DEBUG : Setting encoding="BackSlash,Ctl,Del,Dot,RightSpace,Slash,SquareBracket" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_ENCODING 2025/10/04 01:01:59 DEBUG : TestFTPPureftpd: detected overridden config - adding "{qcyny}" suffix to name 2025/10/04 01:01:59 DEBUG : Setting host="172.17.0.5" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_HOST 2025/10/04 01:01:59 DEBUG : Setting user="rclone" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_USER 2025/10/04 01:01:59 DEBUG : Setting pass="2uVhIzhVfnAIN-2HibnJbDd_x4XH07hJret1mz--oec" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_PASS 2025/10/04 01:01:59 DEBUG : Setting encoding="BackSlash,Ctl,Del,Dot,RightSpace,Slash,SquareBracket" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_ENCODING 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: Connecting to FTP server 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:21") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:37702->172.17.0.5:21, err= 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:35350") 2025/10/04 01:01:59 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:58290->172.17.0.5:35350, err= === RUN TestIntegration/FsMkdir/FsPutFiles/Internal/TimePrecision === RUN TestIntegration/FsMkdir/FsPutChunked fstests.go:2364: *ftp.Fs does not implement SetUploadChunkSizer === RUN TestIntegration/FsMkdir/FsCopyChunked fstests.go:2476: FS has no Copier interface === RUN TestIntegration/FsMkdir/FsUploadUnknownSize === RUN TestIntegration/FsMkdir/FsUploadUnknownSize/FsPutUnknownSize 2025/10/04 01:02:00 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:30369") 2025/10/04 01:02:00 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:50478->172.17.0.5:30369, err= === RUN TestIntegration/FsMkdir/FsUploadUnknownSize/FsUpdateUnknownSize 2025/10/04 01:02:00 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:31641") 2025/10/04 01:02:00 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:33572->172.17.0.5:31641, err= 2025/10/04 01:02:00 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:39374") 2025/10/04 01:02:00 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:54044->172.17.0.5:39374, err= === RUN TestIntegration/FsMkdir/FsRootCollapse 2025/10/04 01:02:00 DEBUG : Creating backend with remote "TestFTPPureftpd:rclone-test-tusisud2hoqe/deeper/nonexisting/directory" 2025/10/04 01:02:00 DEBUG : Setting type="ftp" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_TYPE 2025/10/04 01:02:00 DEBUG : Setting host="172.17.0.5" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_HOST 2025/10/04 01:02:00 DEBUG : Setting user="rclone" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_USER 2025/10/04 01:02:00 DEBUG : Setting pass="2uVhIzhVfnAIN-2HibnJbDd_x4XH07hJret1mz--oec" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_PASS 2025/10/04 01:02:00 DEBUG : Setting encoding="BackSlash,Ctl,Del,Dot,RightSpace,Slash,SquareBracket" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_ENCODING 2025/10/04 01:02:00 DEBUG : TestFTPPureftpd: detected overridden config - adding "{0ueLh}" suffix to name 2025/10/04 01:02:00 DEBUG : Setting host="172.17.0.5" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_HOST 2025/10/04 01:02:00 DEBUG : Setting user="rclone" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_USER 2025/10/04 01:02:00 DEBUG : Setting pass="2uVhIzhVfnAIN-2HibnJbDd_x4XH07hJret1mz--oec" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_PASS 2025/10/04 01:02:00 DEBUG : Setting encoding="BackSlash,Ctl,Del,Dot,RightSpace,Slash,SquareBracket" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_ENCODING 2025/10/04 01:02:00 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/deeper/nonexisting/directory: Connecting to FTP server 2025/10/04 01:02:00 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/deeper/nonexisting/directory: dial("tcp","172.17.0.5:21") 2025/10/04 01:02:00 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe/deeper/nonexisting/directory: > dial: conn=172.17.0.1:37716->172.17.0.5:21, err= === RUN TestIntegration/FsMkdir/FsDirSetModTime fstests.go:2625: FS has no DirSetModTime interface === RUN TestIntegration/FsMkdir/FsMkdirMetadata fstests.go:2668: FS has no MkdirMetadata interface === RUN TestIntegration/FsMkdir/FsDirectory fstests.go:2725: FS has no Directory methods and doesn't Wrap 2025/10/04 01:02:00 DEBUG : Waiting for deletions to finish 2025/10/04 01:02:00 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:36732") 2025/10/04 01:02:00 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:43396->172.17.0.5:36732, err= 2025/10/04 01:02:00 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:33506") 2025/10/04 01:02:00 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:52968->172.17.0.5:33506, err= 2025/10/04 01:02:00 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:38734") 2025/10/04 01:02:00 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:36178->172.17.0.5:38734, err= 2025/10/04 01:02:00 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:35357") 2025/10/04 01:02:00 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:49108->172.17.0.5:35357, err= 2025/10/04 01:02:00 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:30377") 2025/10/04 01:02:00 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:53156->172.17.0.5:30377, err= 2025/10/04 01:02:00 INFO : hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: Deleted 2025/10/04 01:02:00 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:35030") 2025/10/04 01:02:00 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:45174->172.17.0.5:35030, err= 2025/10/04 01:02:00 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:35197") 2025/10/04 01:02:00 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:46308->172.17.0.5:35197, err= 2025/10/04 01:02:00 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:30176") 2025/10/04 01:02:00 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:59084->172.17.0.5:30176, err= 2025/10/04 01:02:00 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:35751") 2025/10/04 01:02:00 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:36604->172.17.0.5:35751, err= 2025/10/04 01:02:00 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:33576") 2025/10/04 01:02:00 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:33178->172.17.0.5:33576, err= 2025/10/04 01:02:00 DEBUG : removing 1 level 4 directories 2025/10/04 01:02:00 INFO : hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠: Removing directory 2025/10/04 01:02:00 DEBUG : removing 1 level 3 directories 2025/10/04 01:02:00 INFO : hello? sausage/êé/Hello, 世界: Removing directory 2025/10/04 01:02:00 DEBUG : removing 1 level 2 directories 2025/10/04 01:02:00 INFO : hello? sausage/êé: Removing directory 2025/10/04 01:02:00 DEBUG : removing 1 level 1 directories 2025/10/04 01:02:00 INFO : hello? sausage: Removing directory 2025/10/04 01:02:00 DEBUG : removing 1 level 0 directories 2025/10/04 01:02:00 INFO : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: Removing directory 2025/10/04 01:02:00 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:35415") 2025/10/04 01:02:00 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:60696->172.17.0.5:35415, err= 2025/10/04 01:02:00 ERROR : error listing: directory not found 2025/10/04 01:02:00 DEBUG : Waiting for deletions to finish 2025/10/04 01:02:00 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:39569") 2025/10/04 01:02:00 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:50602->172.17.0.5:39569, err= 2025/10/04 01:02:00 ERROR : error listing: directory not found 2025/10/04 01:02:00 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: dial("tcp","172.17.0.5:34493") 2025/10/04 01:02:00 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: > dial: conn=172.17.0.1:32776->172.17.0.5:34493, err= 2025/10/04 01:02:00 ERROR : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: Failed to list "": directory not found 2025/10/04 01:02:00 DEBUG : removing 1 level 0 directories 2025/10/04 01:02:00 INFO : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: Removing directory 2025/10/04 01:02:00 ERROR : Failed to rmdir: directory not found === RUN TestIntegration/FsShutdown 2025/10/04 01:02:00 DEBUG : ftp://172.17.0.5:21/rclone-test-tusisud2hoqe: closing 2 unused connections --- PASS: TestIntegration (2.85s) --- SKIP: TestIntegration/FsCheckWrap (0.00s) --- SKIP: TestIntegration/FsCommand (0.00s) --- PASS: TestIntegration/FsRmdirNotFound (0.00s) --- PASS: TestIntegration/FsString (0.00s) --- PASS: TestIntegration/FsName (0.00s) --- PASS: TestIntegration/FsRoot (0.00s) --- PASS: TestIntegration/FsRmdirEmpty (0.00s) --- PASS: TestIntegration/FsMkdir (2.74s) --- PASS: TestIntegration/FsMkdir/FsMkdirRmdirSubdir (0.01s) --- PASS: TestIntegration/FsMkdir/FsListEmpty (0.00s) --- PASS: TestIntegration/FsMkdir/FsListDirEmpty (0.00s) --- SKIP: TestIntegration/FsMkdir/FsListRDirEmpty (0.00s) --- PASS: TestIntegration/FsMkdir/FsListDirNotFound (0.00s) --- SKIP: TestIntegration/FsMkdir/FsListRDirNotFound (0.00s) --- PASS: TestIntegration/FsMkdir/FsEncoding (0.10s) --- PASS: TestIntegration/FsMkdir/FsEncoding/control_chars (0.00s) --- PASS: TestIntegration/FsMkdir/FsEncoding/dot (0.01s) --- PASS: TestIntegration/FsMkdir/FsEncoding/dot_dot (0.01s) --- PASS: TestIntegration/FsMkdir/FsEncoding/punctuation (0.00s) --- PASS: TestIntegration/FsMkdir/FsEncoding/leading_space (0.01s) --- PASS: TestIntegration/FsMkdir/FsEncoding/leading_tilde (0.01s) --- PASS: TestIntegration/FsMkdir/FsEncoding/leading_CR (0.00s) --- PASS: TestIntegration/FsMkdir/FsEncoding/leading_LF (0.00s) --- PASS: TestIntegration/FsMkdir/FsEncoding/leading_HT (0.00s) --- PASS: TestIntegration/FsMkdir/FsEncoding/leading_VT (0.01s) --- PASS: TestIntegration/FsMkdir/FsEncoding/leading_dot (0.01s) --- PASS: TestIntegration/FsMkdir/FsEncoding/trailing_space (0.00s) --- PASS: TestIntegration/FsMkdir/FsEncoding/trailing_CR (0.00s) --- PASS: TestIntegration/FsMkdir/FsEncoding/trailing_LF (0.00s) --- PASS: TestIntegration/FsMkdir/FsEncoding/trailing_HT (0.00s) --- PASS: TestIntegration/FsMkdir/FsEncoding/trailing_VT (0.00s) --- PASS: TestIntegration/FsMkdir/FsEncoding/trailing_dot (0.00s) --- PASS: TestIntegration/FsMkdir/FsEncoding/invalid_UTF-8 (0.00s) --- PASS: TestIntegration/FsMkdir/FsEncoding/URL_encoding (0.00s) --- PASS: TestIntegration/FsMkdir/FsNewObjectNotFound (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutError (1.03s) --- PASS: TestIntegration/FsMkdir/FsPutZeroLength (0.00s) --- SKIP: TestIntegration/FsMkdir/FsOpenWriterAt (0.00s) --- SKIP: TestIntegration/FsMkdir/FsOpenChunkWriter (0.00s) --- SKIP: TestIntegration/FsMkdir/FsChangeNotify (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles (1.56s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListDirFile2 (0.01s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FsListRDirFile2 (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListR (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListRSubdir (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListDirRoot (0.02s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FsListRDirRoot (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListSubdir (0.00s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FsListRSubdir#01 (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListLevel2 (0.00s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FsListRLevel2 (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListFile1 (0.01s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsNewObject (0.00s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FsNewObjectCaseInsensitive (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListFile1and2 (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsNewObjectDir (0.00s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FsPurge (0.00s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FsPurgeRoot (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListRootedSubdir (0.05s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FsCopy (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsMove (0.03s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FsMove/Metadata (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsDirMove (0.02s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsRmdirFull (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsPrecision (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectString (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectFs (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectRemote (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectHashes (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectModTime (0.00s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/ObjectMimeType (0.00s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/ObjectMetadata (0.00s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/ObjectSetMetadata (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectSetModTime (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectSize (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectOpen (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectOpenSeek (0.01s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectOpenRange (0.04s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectPartialRead (0.01s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectUpdate (0.01s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectStorable (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsIsFile (0.03s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsIsFile/FsRoot (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsIsFileNotFound (0.03s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FromRoot (0.04s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FromRoot/List (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FromRoot/ListEntries (0.00s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FromRoot/ListR (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FromRoot/Put (0.01s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FromRoot/Put/Remove (0.00s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/PublicLink (0.00s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/SetTier (0.00s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/ObjectCheckWrap (0.00s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/Bucket (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectRemove (0.00s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/ObjectAbout (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsPutStream (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsPutStream/0 (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsPutStream/100 (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/Internal (1.22s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/Internal/UploadTimeout (1.22s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/Internal/TimePrecision (0.00s) --- SKIP: TestIntegration/FsMkdir/FsPutChunked (0.00s) --- SKIP: TestIntegration/FsMkdir/FsCopyChunked (0.00s) --- PASS: TestIntegration/FsMkdir/FsUploadUnknownSize (0.00s) --- PASS: TestIntegration/FsMkdir/FsUploadUnknownSize/FsPutUnknownSize (0.00s) --- PASS: TestIntegration/FsMkdir/FsUploadUnknownSize/FsUpdateUnknownSize (0.00s) --- PASS: TestIntegration/FsMkdir/FsRootCollapse (0.02s) --- SKIP: TestIntegration/FsMkdir/FsDirSetModTime (0.00s) --- SKIP: TestIntegration/FsMkdir/FsMkdirMetadata (0.00s) --- SKIP: TestIntegration/FsMkdir/FsDirectory (0.00s) --- PASS: TestIntegration/FsShutdown (0.00s) === RUN TestIntegrationProftpd ftp_test.go:23: skipping as -remote is set --- SKIP: TestIntegrationProftpd (0.00s) === RUN TestIntegrationPureftpd ftp_test.go:34: skipping as -remote is set --- SKIP: TestIntegrationPureftpd (0.00s) === RUN TestIntegrationVsftpd ftp_test.go:45: skipping as -remote is set --- SKIP: TestIntegrationVsftpd (0.00s) PASS ok github.com/rclone/rclone/backend/ftp 2.877s "go test -v -timeout 1h0m0s -remote TestFTPPureftpd: -verbose" - Finished OK in 4.788391956s (try 1/5)