"go test -v -timeout 1h0m0s -remote TestFTPPureftpd: -verbose" - Starting (try 1/5) === RUN TestIntegration fstests.go:438: Using remote "TestFTPPureftpd:" 2025/11/10 04:10:53 NOTICE: TestFTPPureftpd: Starting server 2025/11/10 04:10:54 NOTICE: TestFTPPureftpd: Attempting to connect to "172.17.0.2:21" try 1/100 2025/11/10 04:10:54 DEBUG : TestFTPPureftpd: Read 1, error: 2025/11/10 04:10:54 NOTICE: TestFTPPureftpd: Started server and connected to "172.17.0.2:21" 2025/11/10 04:10:54 DEBUG : Creating backend with remote "TestFTPPureftpd:rclone-test-lipeqij4muge" 2025/11/10 04:10:54 DEBUG : Using config file from "/home/rclone/.rclone.conf" 2025/11/10 04:10:54 DEBUG : Setting type="ftp" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_TYPE 2025/11/10 04:10:54 DEBUG : Setting host="172.17.0.2" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_HOST 2025/11/10 04:10:54 DEBUG : Setting user="rclone" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_USER 2025/11/10 04:10:54 DEBUG : Setting pass="SUR9qrUeOw_XyVmAxe4XiimtkU-ozW9GhIhSRCXK0Wo" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_PASS 2025/11/10 04:10:54 DEBUG : Setting encoding="BackSlash,Ctl,Del,Dot,RightSpace,Slash,SquareBracket" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_ENCODING 2025/11/10 04:10:54 DEBUG : TestFTPPureftpd: detected overridden config - adding "{qY9KD}" suffix to name 2025/11/10 04:10:54 DEBUG : Setting host="172.17.0.2" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_HOST 2025/11/10 04:10:54 DEBUG : Setting user="rclone" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_USER 2025/11/10 04:10:54 DEBUG : Setting pass="SUR9qrUeOw_XyVmAxe4XiimtkU-ozW9GhIhSRCXK0Wo" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_PASS 2025/11/10 04:10:54 DEBUG : Setting encoding="BackSlash,Ctl,Del,Dot,RightSpace,Slash,SquareBracket" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_ENCODING 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: Connecting to FTP server 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:21") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:37814->172.17.0.2:21, err= 2025/11/10 04:10:54 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/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:37894") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:47848->172.17.0.2:37894, err= === RUN TestIntegration/FsString === RUN TestIntegration/FsName === RUN TestIntegration/FsRoot === RUN TestIntegration/FsRmdirEmpty === RUN TestIntegration/FsMkdir 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:30357") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:36918->172.17.0.2:30357, err= === RUN TestIntegration/FsMkdir/FsMkdirRmdirSubdir 2025/11/10 04:10:54 INFO : dir/subdir: Making directory 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:32721") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:53890->172.17.0.2:32721, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:33182") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:50608->172.17.0.2:33182, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:37312") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:34232->172.17.0.2:37312, err= 2025/11/10 04:10:54 INFO : dir/subdir: Removing directory 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:32292") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:55512->172.17.0.2:32292, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:36789") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:56518->172.17.0.2:36789, err= 2025/11/10 04:10:54 INFO : dir: Removing directory 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:38963") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:34290->172.17.0.2:38963, err= === RUN TestIntegration/FsMkdir/FsListEmpty 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:39514") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:52494->172.17.0.2:39514, err= === RUN TestIntegration/FsMkdir/FsListDirEmpty 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:34482") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:47266->172.17.0.2:34482, err= === RUN TestIntegration/FsMkdir/FsListRDirEmpty fstests.go:399: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsListDirNotFound 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:36077") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:54076->172.17.0.2:36077, err= 2025/11/10 04:10:54 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/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:30999") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:49468->172.17.0.2:30999, err= === RUN TestIntegration/FsMkdir/FsEncoding/control_chars fstests.go:707: testing "␀␁␂␃␄␅␆␇␈␉␊␋␌␍␎␏␐␑␒␓␔␕␖␗␘␙␚␛␜␝␞␟␡" 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:35824") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:54976->172.17.0.2:35824, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:38215") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:56746->172.17.0.2:38215, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:39361") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:52416->172.17.0.2:39361, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:30582") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:36740->172.17.0.2:30582, err= === RUN TestIntegration/FsMkdir/FsEncoding/dot fstests.go:707: testing "．" 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:38621") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:48384->172.17.0.2:38621, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:30081") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:33088->172.17.0.2:30081, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:37116") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:59354->172.17.0.2:37116, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:39689") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:48130->172.17.0.2:39689, err= === RUN TestIntegration/FsMkdir/FsEncoding/dot_dot fstests.go:707: testing "．．" 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:39149") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:51770->172.17.0.2:39149, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:38609") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:48510->172.17.0.2:38609, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:35200") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:39168->172.17.0.2:35200, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:39972") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:38318->172.17.0.2:39972, err= === RUN TestIntegration/FsMkdir/FsEncoding/punctuation fstests.go:707: testing "!\"#$%&'()*+,-.／:;<=>?@[\\]^_`{|}~" 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:39484") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:33694->172.17.0.2:39484, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:35289") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:36680->172.17.0.2:35289, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:34071") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:41266->172.17.0.2:34071, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:32336") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:49584->172.17.0.2:32336, err= === RUN TestIntegration/FsMkdir/FsEncoding/leading_space fstests.go:707: testing " leading space" 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:30242") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:57248->172.17.0.2:30242, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:33510") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:56942->172.17.0.2:33510, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:30732") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:58386->172.17.0.2:30732, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:30878") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:38696->172.17.0.2:30878, err= === RUN TestIntegration/FsMkdir/FsEncoding/leading_tilde fstests.go:707: testing "~leading tilde" 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:33295") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:42054->172.17.0.2:33295, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:34064") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:55938->172.17.0.2:34064, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:31687") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:35630->172.17.0.2:31687, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:36380") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:48554->172.17.0.2:36380, err= === RUN TestIntegration/FsMkdir/FsEncoding/leading_CR fstests.go:707: testing "␍leading CR" 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:34216") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:53954->172.17.0.2:34216, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:37790") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:50346->172.17.0.2:37790, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:30793") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:57986->172.17.0.2:30793, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:34457") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:37796->172.17.0.2:34457, err= === RUN TestIntegration/FsMkdir/FsEncoding/leading_LF fstests.go:707: testing "␊leading LF" 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:39268") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:37670->172.17.0.2:39268, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:34242") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:45586->172.17.0.2:34242, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:33568") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:32928->172.17.0.2:33568, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:34154") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:37740->172.17.0.2:34154, err= === RUN TestIntegration/FsMkdir/FsEncoding/leading_HT fstests.go:707: testing "␉leading HT" 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:36944") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:39230->172.17.0.2:36944, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:39102") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:49214->172.17.0.2:39102, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:32659") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:55130->172.17.0.2:32659, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:36991") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:35202->172.17.0.2:36991, err= === RUN TestIntegration/FsMkdir/FsEncoding/leading_VT fstests.go:707: testing "␋leading VT" 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:34007") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:41822->172.17.0.2:34007, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:37744") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:60510->172.17.0.2:37744, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:33038") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:34480->172.17.0.2:33038, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:30314") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:53932->172.17.0.2:30314, err= === RUN TestIntegration/FsMkdir/FsEncoding/leading_dot fstests.go:707: testing ".leading dot" 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:37474") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:60204->172.17.0.2:37474, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:39689") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:48146->172.17.0.2:39689, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:34452") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:40620->172.17.0.2:34452, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:32058") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:34066->172.17.0.2:32058, err= === RUN TestIntegration/FsMkdir/FsEncoding/trailing_space fstests.go:707: testing "trailing space " 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:33133") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:51116->172.17.0.2:33133, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:30494") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:59610->172.17.0.2:30494, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:31799") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:48314->172.17.0.2:31799, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:34767") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:57140->172.17.0.2:34767, err= === RUN TestIntegration/FsMkdir/FsEncoding/trailing_CR fstests.go:707: testing "trailing CR␍" 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:37385") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:49628->172.17.0.2:37385, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:38117") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:58206->172.17.0.2:38117, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:30578") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:53560->172.17.0.2:30578, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:39227") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:35414->172.17.0.2:39227, err= === RUN TestIntegration/FsMkdir/FsEncoding/trailing_LF fstests.go:707: testing "trailing LF␊" 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:36411") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:51574->172.17.0.2:36411, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:32798") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:47520->172.17.0.2:32798, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:36464") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:57528->172.17.0.2:36464, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:38683") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:43010->172.17.0.2:38683, err= === RUN TestIntegration/FsMkdir/FsEncoding/trailing_HT fstests.go:707: testing "trailing HT␉" 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:31054") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:54088->172.17.0.2:31054, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:37602") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:55982->172.17.0.2:37602, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:38632") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:49060->172.17.0.2:38632, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:34813") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:50172->172.17.0.2:34813, err= === RUN TestIntegration/FsMkdir/FsEncoding/trailing_VT fstests.go:707: testing "trailing VT␋" 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:31675") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:36438->172.17.0.2:31675, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:38189") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:54644->172.17.0.2:38189, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:39125") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:38886->172.17.0.2:39125, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:30091") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:49744->172.17.0.2:30091, err= === RUN TestIntegration/FsMkdir/FsEncoding/trailing_dot fstests.go:707: testing "trailing dot." 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:35665") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:56808->172.17.0.2:35665, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:37488") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:55148->172.17.0.2:37488, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:30454") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:51830->172.17.0.2:30454, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:34848") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:47886->172.17.0.2:34848, err= === RUN TestIntegration/FsMkdir/FsEncoding/invalid_UTF-8 fstests.go:707: testing "invalid utf-8\xfe" 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:37415") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:47526->172.17.0.2:37415, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:31928") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:39676->172.17.0.2:31928, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:39468") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:56336->172.17.0.2:39468, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:35387") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:43640->172.17.0.2:35387, err= === RUN TestIntegration/FsMkdir/FsEncoding/URL_encoding fstests.go:707: testing "test%46.txt" 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:36929") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:52136->172.17.0.2:36929, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:38932") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:38876->172.17.0.2:38932, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:32443") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:43340->172.17.0.2:32443, err= 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:34017") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:51000->172.17.0.2:34017, err= === RUN TestIntegration/FsMkdir/FsNewObjectNotFound === RUN TestIntegration/FsMkdir/FsPutError 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:35084") 2025/11/10 04:10:54 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:56778->172.17.0.2:35084, err= 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: Connecting to FTP server 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:21") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:37828->172.17.0.2:21, err= 2025/11/10 04:10:55 DEBUG : hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: Removed after failed upload: 1 error occurred: * potato === RUN TestIntegration/FsMkdir/FsPutZeroLength 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:31376") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:52098->172.17.0.2:31376, err= 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:31163") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:43714->172.17.0.2:31163, 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/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:31836") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:35736->172.17.0.2:31836, err= 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:36134") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:38412->172.17.0.2:36134, err= 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:39886") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:40360->172.17.0.2:39886, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsListDirFile2 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:37039") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:36688->172.17.0.2:37039, err= 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:37911") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:58746->172.17.0.2:37911, err= 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:30155") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:43860->172.17.0.2:30155, err= 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:38782") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:38520->172.17.0.2:38782, err= 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:37968") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:53552->172.17.0.2:37968, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsListRDirFile2 fstests.go:399: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsPutFiles/FsListR 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:33190") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:47048->172.17.0.2:33190, err= 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:30659") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:45636->172.17.0.2:30659, err= 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:32203") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:43294->172.17.0.2:32203, err= 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:33178") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:52438->172.17.0.2:33178, err= 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:32780") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:59418->172.17.0.2:32780, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsListRSubdir 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:35538") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:35874->172.17.0.2:35538, err= 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:30595") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:44648->172.17.0.2:30595, err= 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:39088") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:50442->172.17.0.2:39088, err= 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:30468") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:57980->172.17.0.2:30468, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsListDirRoot 2025/11/10 04:10:55 DEBUG : Creating backend with remote "TestFTPPureftpd:" 2025/11/10 04:10:55 DEBUG : Setting type="ftp" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_TYPE 2025/11/10 04:10:55 DEBUG : Setting host="172.17.0.2" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_HOST 2025/11/10 04:10:55 DEBUG : Setting user="rclone" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_USER 2025/11/10 04:10:55 DEBUG : Setting pass="SUR9qrUeOw_XyVmAxe4XiimtkU-ozW9GhIhSRCXK0Wo" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_PASS 2025/11/10 04:10:55 DEBUG : Setting encoding="BackSlash,Ctl,Del,Dot,RightSpace,Slash,SquareBracket" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_ENCODING 2025/11/10 04:10:55 DEBUG : TestFTPPureftpd: detected overridden config - adding "{qY9KD}" suffix to name 2025/11/10 04:10:55 DEBUG : Setting host="172.17.0.2" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_HOST 2025/11/10 04:10:55 DEBUG : Setting user="rclone" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_USER 2025/11/10 04:10:55 DEBUG : Setting pass="SUR9qrUeOw_XyVmAxe4XiimtkU-ozW9GhIhSRCXK0Wo" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_PASS 2025/11/10 04:10:55 DEBUG : Setting encoding="BackSlash,Ctl,Del,Dot,RightSpace,Slash,SquareBracket" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_ENCODING 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21: Connecting to FTP server 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21: dial("tcp","172.17.0.2:21") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21: > dial: conn=172.17.0.1:37832->172.17.0.2:21, err= 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21: dial("tcp","172.17.0.2:33087") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21: > dial: conn=172.17.0.1:53496->172.17.0.2:33087, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsListRDirRoot fstests.go:399: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsPutFiles/FsListSubdir 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:35422") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:47752->172.17.0.2:35422, err= 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:38562") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:49172->172.17.0.2:38562, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsListRSubdir#01 fstests.go:399: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsPutFiles/FsListLevel2 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:39796") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:50386->172.17.0.2:39796, err= 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:37056") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:58952->172.17.0.2:37056, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsListRLevel2 fstests.go:399: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsPutFiles/FsListFile1 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:33693") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:45394->172.17.0.2:33693, err= 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:35553") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:47944->172.17.0.2:35553, err= 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:33541") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:40496->172.17.0.2:33541, err= 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:31826") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:39962->172.17.0.2:31826, err= 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:37085") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:49788->172.17.0.2:37085, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsNewObject === RUN TestIntegration/FsMkdir/FsPutFiles/FsNewObjectCaseInsensitive fstests.go:1121: Not Case Insensitive === RUN TestIntegration/FsMkdir/FsPutFiles/FsListFile1and2 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:39749") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:48448->172.17.0.2:39749, err= 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:31932") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:60048->172.17.0.2:31932, err= 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:39865") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:40004->172.17.0.2:39865, err= 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:35045") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:59400->172.17.0.2:35045, err= 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:33552") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:36366->172.17.0.2:33552, 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/11/10 04:10:55 DEBUG : Creating backend with remote "TestFTPPureftpd:rclone-test-lipeqij4muge/hello? sausage/êé" 2025/11/10 04:10:55 DEBUG : Setting type="ftp" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_TYPE 2025/11/10 04:10:55 DEBUG : Setting host="172.17.0.2" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_HOST 2025/11/10 04:10:55 DEBUG : Setting user="rclone" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_USER 2025/11/10 04:10:55 DEBUG : Setting pass="SUR9qrUeOw_XyVmAxe4XiimtkU-ozW9GhIhSRCXK0Wo" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_PASS 2025/11/10 04:10:55 DEBUG : Setting encoding="BackSlash,Ctl,Del,Dot,RightSpace,Slash,SquareBracket" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_ENCODING 2025/11/10 04:10:55 DEBUG : TestFTPPureftpd: detected overridden config - adding "{qY9KD}" suffix to name 2025/11/10 04:10:55 DEBUG : Setting host="172.17.0.2" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_HOST 2025/11/10 04:10:55 DEBUG : Setting user="rclone" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_USER 2025/11/10 04:10:55 DEBUG : Setting pass="SUR9qrUeOw_XyVmAxe4XiimtkU-ozW9GhIhSRCXK0Wo" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_PASS 2025/11/10 04:10:55 DEBUG : Setting encoding="BackSlash,Ctl,Del,Dot,RightSpace,Slash,SquareBracket" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_ENCODING 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: Connecting to FTP server 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: dial("tcp","172.17.0.2:21") 2025/11/10 04:10:55 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: > dial: conn=172.17.0.1:37842->172.17.0.2:21, err= 2025/11/10 04:10:56 DEBUG : fs cache: renaming cache item "TestFTPPureftpd:rclone-test-lipeqij4muge/hello? sausage/êé" to be canonical "TestFTPPureftpd{qY9KD}:rclone-test-lipeqij4muge/hello? sausage/êé" 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: dial("tcp","172.17.0.2:34457") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: > dial: conn=172.17.0.1:37804->172.17.0.2:34457, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: dial("tcp","172.17.0.2:39531") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: > dial: conn=172.17.0.1:40570->172.17.0.2:39531, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: Connecting to FTP server 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: dial("tcp","172.17.0.2:21") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: > dial: conn=172.17.0.1:37854->172.17.0.2:21, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: dial("tcp","172.17.0.2:37504") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: > dial: conn=172.17.0.1:35600->172.17.0.2:37504, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: dial("tcp","172.17.0.2:39276") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: > dial: conn=172.17.0.1:32974->172.17.0.2:39276, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: dial("tcp","172.17.0.2:39444") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: > dial: conn=172.17.0.1:45878->172.17.0.2:39444, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: dial("tcp","172.17.0.2:31039") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: > dial: conn=172.17.0.1:46776->172.17.0.2:31039, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: dial("tcp","172.17.0.2:32346") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: > dial: conn=172.17.0.1:46780->172.17.0.2:32346, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: dial("tcp","172.17.0.2:32067") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: > dial: conn=172.17.0.1:34498->172.17.0.2:32067, err= 2025/11/10 04:10:56 DEBUG : Waiting for deletions to finish 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: dial("tcp","172.17.0.2:37311") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: > dial: conn=172.17.0.1:51214->172.17.0.2:37311, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: dial("tcp","172.17.0.2:32759") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: > dial: conn=172.17.0.1:40672->172.17.0.2:32759, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: dial("tcp","172.17.0.2:34105") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: > dial: conn=172.17.0.1:43294->172.17.0.2:34105, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: dial("tcp","172.17.0.2:38612") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: > dial: conn=172.17.0.1:52012->172.17.0.2:38612, err= 2025/11/10 04:10:56 INFO : a/b/c/d/e.txt: Deleted 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: dial("tcp","172.17.0.2:30255") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: > dial: conn=172.17.0.1:41498->172.17.0.2:30255, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: dial("tcp","172.17.0.2:33573") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: > dial: conn=172.17.0.1:34972->172.17.0.2:33573, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: dial("tcp","172.17.0.2:31496") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: > dial: conn=172.17.0.1:38294->172.17.0.2:31496, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: dial("tcp","172.17.0.2:37382") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé: > dial: conn=172.17.0.1:57868->172.17.0.2:37382, err= 2025/11/10 04:10:56 DEBUG : removing 1 level 4 directories 2025/11/10 04:10:56 INFO : a/b/c/d: Removing directory 2025/11/10 04:10:56 DEBUG : removing 1 level 3 directories 2025/11/10 04:10:56 INFO : a/b/c: Removing directory 2025/11/10 04:10:56 DEBUG : removing 1 level 2 directories 2025/11/10 04:10:56 INFO : a/b: Removing directory 2025/11/10 04:10:56 DEBUG : removing 1 level 1 directories 2025/11/10 04:10:56 INFO : a: Removing directory === RUN TestIntegration/FsMkdir/FsPutFiles/FsCopy fstests.go:1254: FS has no Copier interface === RUN TestIntegration/FsMkdir/FsPutFiles/FsMove 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:31568") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:33240->172.17.0.2:31568, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:31542") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:55484->172.17.0.2:31542, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:35309") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:48656->172.17.0.2:35309, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:38645") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:40374->172.17.0.2:38645, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:31027") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:54118->172.17.0.2:31027, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:36756") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:40760->172.17.0.2:36756, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: Connecting to FTP server 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:21") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:37520") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:37864->172.17.0.2:21, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:58850->172.17.0.2:37520, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:34871") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:52970->172.17.0.2:34871, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:33131") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:43720->172.17.0.2:33131, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:32308") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:38038->172.17.0.2:32308, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:31343") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:35050->172.17.0.2:31343, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:32352") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:49198->172.17.0.2:32352, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:30541") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:59376->172.17.0.2:30541, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:34822") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:57728->172.17.0.2:34822, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:35481") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:59412->172.17.0.2:35481, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:32119") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:38410->172.17.0.2:32119, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:37853") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:50354->172.17.0.2:37853, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:30488") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:53904->172.17.0.2:30488, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:35538") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:35890->172.17.0.2:35538, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:30370") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:33548->172.17.0.2:30370, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:32150") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:51024->172.17.0.2:32150, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:37934") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:60228->172.17.0.2:37934, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:34125") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:44494->172.17.0.2:34125, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsMove/Metadata fstests.go:1398: Skipping test as can't write metadata === RUN TestIntegration/FsMkdir/FsPutFiles/FsDirMove 2025/11/10 04:10:56 DEBUG : Creating backend with remote "TestFTPPureftpd:rclone-test-kegusam0huvu" 2025/11/10 04:10:56 DEBUG : Setting type="ftp" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_TYPE 2025/11/10 04:10:56 DEBUG : Setting host="172.17.0.2" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_HOST 2025/11/10 04:10:56 DEBUG : Setting user="rclone" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_USER 2025/11/10 04:10:56 DEBUG : Setting pass="SUR9qrUeOw_XyVmAxe4XiimtkU-ozW9GhIhSRCXK0Wo" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_PASS 2025/11/10 04:10:56 DEBUG : Setting encoding="BackSlash,Ctl,Del,Dot,RightSpace,Slash,SquareBracket" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_ENCODING 2025/11/10 04:10:56 DEBUG : TestFTPPureftpd: detected overridden config - adding "{qY9KD}" suffix to name 2025/11/10 04:10:56 DEBUG : Setting host="172.17.0.2" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_HOST 2025/11/10 04:10:56 DEBUG : Setting user="rclone" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_USER 2025/11/10 04:10:56 DEBUG : Setting pass="SUR9qrUeOw_XyVmAxe4XiimtkU-ozW9GhIhSRCXK0Wo" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_PASS 2025/11/10 04:10:56 DEBUG : Setting encoding="BackSlash,Ctl,Del,Dot,RightSpace,Slash,SquareBracket" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_ENCODING 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-kegusam0huvu: Connecting to FTP server 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-kegusam0huvu: dial("tcp","172.17.0.2:21") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-kegusam0huvu: > dial: conn=172.17.0.1:37870->172.17.0.2:21, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:39847") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:51310->172.17.0.2:39847, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-kegusam0huvu: dial("tcp","172.17.0.2:31678") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-kegusam0huvu: > dial: conn=172.17.0.1:37022->172.17.0.2:31678, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-kegusam0huvu: dial("tcp","172.17.0.2:30197") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-kegusam0huvu: > dial: conn=172.17.0.1:42282->172.17.0.2:30197, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-kegusam0huvu: dial("tcp","172.17.0.2:39292") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-kegusam0huvu: > dial: conn=172.17.0.1:34780->172.17.0.2:39292, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-kegusam0huvu: dial("tcp","172.17.0.2:37615") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-kegusam0huvu: > dial: conn=172.17.0.1:52374->172.17.0.2:37615, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-kegusam0huvu: dial("tcp","172.17.0.2:32401") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-kegusam0huvu: > dial: conn=172.17.0.1:35458->172.17.0.2:32401, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-kegusam0huvu: dial("tcp","172.17.0.2:39801") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-kegusam0huvu: > dial: conn=172.17.0.1:36380->172.17.0.2:39801, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-kegusam0huvu: dial("tcp","172.17.0.2:35396") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-kegusam0huvu: > dial: conn=172.17.0.1:55030->172.17.0.2:35396, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:30105") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:42250->172.17.0.2:30105, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:33924") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:56694->172.17.0.2:33924, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:30406") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:32900->172.17.0.2:30406, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:31626") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:45096->172.17.0.2:31626, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:33226") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:48240->172.17.0.2:33226, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-kegusam0huvu: dial("tcp","172.17.0.2:34562") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-kegusam0huvu: > dial: conn=172.17.0.1:35830->172.17.0.2:34562, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-kegusam0huvu: dial("tcp","172.17.0.2:31694") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-kegusam0huvu: > dial: conn=172.17.0.1:40614->172.17.0.2:31694, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-kegusam0huvu: dial("tcp","172.17.0.2:32105") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-kegusam0huvu: > dial: conn=172.17.0.1:49670->172.17.0.2:32105, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-kegusam0huvu: dial("tcp","172.17.0.2:37516") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-kegusam0huvu: > dial: conn=172.17.0.1:48450->172.17.0.2:37516, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-kegusam0huvu: Purge dir "new_name" 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-kegusam0huvu: 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/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:39728") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:58496->172.17.0.2:39728, err= === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectOpenSeek 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:36931") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:60268->172.17.0.2:36931, err= === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectOpenRange 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:32904") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:45228->172.17.0.2:32904, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:30906") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:39996->172.17.0.2:30906, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:35726") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:36480->172.17.0.2:35726, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:34646") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:59908->172.17.0.2:34646, err= === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectPartialRead 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:37990") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:54624->172.17.0.2:37990, err= === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectUpdate 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:32847") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:35160->172.17.0.2:32847, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:39538") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:60238->172.17.0.2:39538, err= === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectStorable === RUN TestIntegration/FsMkdir/FsPutFiles/FsIsFile 2025/11/10 04:10:56 DEBUG : Creating backend with remote "TestFTPPureftpd:rclone-test-lipeqij4muge/hello? sausage/êé/Hello, 世界/ \" ' @ < > & ? + ≠/z.txt" 2025/11/10 04:10:56 DEBUG : Setting type="ftp" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_TYPE 2025/11/10 04:10:56 DEBUG : Setting host="172.17.0.2" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_HOST 2025/11/10 04:10:56 DEBUG : Setting user="rclone" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_USER 2025/11/10 04:10:56 DEBUG : Setting pass="SUR9qrUeOw_XyVmAxe4XiimtkU-ozW9GhIhSRCXK0Wo" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_PASS 2025/11/10 04:10:56 DEBUG : Setting encoding="BackSlash,Ctl,Del,Dot,RightSpace,Slash,SquareBracket" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_ENCODING 2025/11/10 04:10:56 DEBUG : TestFTPPureftpd: detected overridden config - adding "{qY9KD}" suffix to name 2025/11/10 04:10:56 DEBUG : Setting host="172.17.0.2" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_HOST 2025/11/10 04:10:56 DEBUG : Setting user="rclone" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_USER 2025/11/10 04:10:56 DEBUG : Setting pass="SUR9qrUeOw_XyVmAxe4XiimtkU-ozW9GhIhSRCXK0Wo" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_PASS 2025/11/10 04:10:56 DEBUG : Setting encoding="BackSlash,Ctl,Del,Dot,RightSpace,Slash,SquareBracket" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_ENCODING 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: Connecting to FTP server 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: dial("tcp","172.17.0.2:21") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: > dial: conn=172.17.0.1:37878->172.17.0.2:21, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsIsFile/FsRoot 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: dial("tcp","172.17.0.2:30632") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: > dial: conn=172.17.0.1:35280->172.17.0.2:30632, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsIsFileNotFound 2025/11/10 04:10:56 DEBUG : Creating backend with remote "TestFTPPureftpd:rclone-test-lipeqij4muge/not found.txt" 2025/11/10 04:10:56 DEBUG : Setting type="ftp" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_TYPE 2025/11/10 04:10:56 DEBUG : Setting host="172.17.0.2" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_HOST 2025/11/10 04:10:56 DEBUG : Setting user="rclone" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_USER 2025/11/10 04:10:56 DEBUG : Setting pass="SUR9qrUeOw_XyVmAxe4XiimtkU-ozW9GhIhSRCXK0Wo" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_PASS 2025/11/10 04:10:56 DEBUG : Setting encoding="BackSlash,Ctl,Del,Dot,RightSpace,Slash,SquareBracket" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_ENCODING 2025/11/10 04:10:56 DEBUG : TestFTPPureftpd: detected overridden config - adding "{qY9KD}" suffix to name 2025/11/10 04:10:56 DEBUG : Setting host="172.17.0.2" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_HOST 2025/11/10 04:10:56 DEBUG : Setting user="rclone" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_USER 2025/11/10 04:10:56 DEBUG : Setting pass="SUR9qrUeOw_XyVmAxe4XiimtkU-ozW9GhIhSRCXK0Wo" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_PASS 2025/11/10 04:10:56 DEBUG : Setting encoding="BackSlash,Ctl,Del,Dot,RightSpace,Slash,SquareBracket" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_ENCODING 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/not found.txt: Connecting to FTP server 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/not found.txt: dial("tcp","172.17.0.2:21") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/not found.txt: > dial: conn=172.17.0.1:37894->172.17.0.2:21, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/not found.txt: dial("tcp","172.17.0.2:34407") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/not found.txt: > dial: conn=172.17.0.1:33836->172.17.0.2:34407, err= 2025/11/10 04:10:56 ERROR : error listing: directory not found === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot fstests.go:1911: Opening root remote "TestFTPPureftpd:" path "rclone-test-lipeqij4muge" from "TestFTPPureftpd:rclone-test-lipeqij4muge" 2025/11/10 04:10:56 DEBUG : Creating backend with remote "TestFTPPureftpd:" 2025/11/10 04:10:56 DEBUG : Setting type="ftp" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_TYPE 2025/11/10 04:10:56 DEBUG : Setting host="172.17.0.2" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_HOST 2025/11/10 04:10:56 DEBUG : Setting user="rclone" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_USER 2025/11/10 04:10:56 DEBUG : Setting pass="SUR9qrUeOw_XyVmAxe4XiimtkU-ozW9GhIhSRCXK0Wo" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_PASS 2025/11/10 04:10:56 DEBUG : Setting encoding="BackSlash,Ctl,Del,Dot,RightSpace,Slash,SquareBracket" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_ENCODING 2025/11/10 04:10:56 DEBUG : TestFTPPureftpd: detected overridden config - adding "{qY9KD}" suffix to name 2025/11/10 04:10:56 DEBUG : Setting host="172.17.0.2" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_HOST 2025/11/10 04:10:56 DEBUG : Setting user="rclone" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_USER 2025/11/10 04:10:56 DEBUG : Setting pass="SUR9qrUeOw_XyVmAxe4XiimtkU-ozW9GhIhSRCXK0Wo" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_PASS 2025/11/10 04:10:56 DEBUG : Setting encoding="BackSlash,Ctl,Del,Dot,RightSpace,Slash,SquareBracket" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_ENCODING 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: Connecting to FTP server 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: dial("tcp","172.17.0.2:21") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: > dial: conn=172.17.0.1:37902->172.17.0.2:21, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot/List 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: dial("tcp","172.17.0.2:39596") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: > dial: conn=172.17.0.1:39964->172.17.0.2:39596, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: dial("tcp","172.17.0.2:30557") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: > dial: conn=172.17.0.1:53842->172.17.0.2:30557, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: dial("tcp","172.17.0.2:33498") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: > dial: conn=172.17.0.1:50518->172.17.0.2:33498, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: dial("tcp","172.17.0.2:39193") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: > dial: conn=172.17.0.1:39898->172.17.0.2:39193, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: dial("tcp","172.17.0.2:33092") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: > dial: conn=172.17.0.1:45688->172.17.0.2:33092, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot/ListEntries 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: dial("tcp","172.17.0.2:34476") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: > dial: conn=172.17.0.1:58508->172.17.0.2:34476, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot/ListR fstests.go:1945: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot/Put 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: dial("tcp","172.17.0.2:31650") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: > dial: conn=172.17.0.1:33628->172.17.0.2:31650, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: dial("tcp","172.17.0.2:36942") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: > dial: conn=172.17.0.1:40166->172.17.0.2:36942, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: dial("tcp","172.17.0.2:37720") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: > dial: conn=172.17.0.1:48314->172.17.0.2:37720, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: dial("tcp","172.17.0.2:35945") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: > dial: conn=172.17.0.1:51972->172.17.0.2:35945, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: dial("tcp","172.17.0.2:36786") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: > dial: conn=172.17.0.1:58078->172.17.0.2:36786, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: dial("tcp","172.17.0.2:31151") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: > dial: conn=172.17.0.1:50436->172.17.0.2:31151, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot/Put/Remove 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: dial("tcp","172.17.0.2:38679") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: > dial: conn=172.17.0.1:50862->172.17.0.2:38679, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: dial("tcp","172.17.0.2:39927") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: > dial: conn=172.17.0.1:52412->172.17.0.2:39927, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: dial("tcp","172.17.0.2:32622") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: > dial: conn=172.17.0.1:50468->172.17.0.2:32622, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: dial("tcp","172.17.0.2:35776") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: > dial: conn=172.17.0.1:50422->172.17.0.2:35776, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: dial("tcp","172.17.0.2:34459") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21: > dial: conn=172.17.0.1:55832->172.17.0.2:34459, 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/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:31141") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:45902->172.17.0.2:31141, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:37022") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:37622->172.17.0.2:37022, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:38987") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:48106->172.17.0.2:38987, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:39211") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:57694->172.17.0.2:39211, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:36044") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:54948->172.17.0.2:36044, 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/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:32626") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:45694->172.17.0.2:32626, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsPutStream/100 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:32996") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:57344->172.17.0.2:32996, err= === RUN TestIntegration/FsMkdir/FsPutFiles/Internal === RUN TestIntegration/FsMkdir/FsPutFiles/Internal/UploadTimeout 2025/11/10 04:10:56 DEBUG : Creating backend with remote "TestFTPPureftpd,concurrency='0',shut_timeout='1s':rclone-test-lipeqij4muge" 2025/11/10 04:10:56 DEBUG : Setting type="ftp" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_TYPE 2025/11/10 04:10:56 DEBUG : Setting host="172.17.0.2" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_HOST 2025/11/10 04:10:56 DEBUG : Setting user="rclone" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_USER 2025/11/10 04:10:56 DEBUG : Setting pass="SUR9qrUeOw_XyVmAxe4XiimtkU-ozW9GhIhSRCXK0Wo" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_PASS 2025/11/10 04:10:56 DEBUG : Setting encoding="BackSlash,Ctl,Del,Dot,RightSpace,Slash,SquareBracket" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_ENCODING 2025/11/10 04:10:56 DEBUG : TestFTPPureftpd: detected overridden config - adding "{ee8kH}" suffix to name 2025/11/10 04:10:56 DEBUG : Setting host="172.17.0.2" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_HOST 2025/11/10 04:10:56 DEBUG : Setting user="rclone" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_USER 2025/11/10 04:10:56 DEBUG : Setting pass="SUR9qrUeOw_XyVmAxe4XiimtkU-ozW9GhIhSRCXK0Wo" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_PASS 2025/11/10 04:10:56 DEBUG : Setting encoding="BackSlash,Ctl,Del,Dot,RightSpace,Slash,SquareBracket" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_ENCODING 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: Connecting to FTP server 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:21") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:37912->172.17.0.2:21, err= 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:30188") 2025/11/10 04:10:56 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:48084->172.17.0.2:30188, 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/11/10 04:10:57 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:33262") 2025/11/10 04:10:57 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:60986->172.17.0.2:33262, err= === RUN TestIntegration/FsMkdir/FsUploadUnknownSize/FsUpdateUnknownSize 2025/11/10 04:10:57 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:36125") 2025/11/10 04:10:57 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:57220->172.17.0.2:36125, err= 2025/11/10 04:10:57 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:31278") 2025/11/10 04:10:57 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:55884->172.17.0.2:31278, err= === RUN TestIntegration/FsMkdir/FsRootCollapse 2025/11/10 04:10:57 DEBUG : Creating backend with remote "TestFTPPureftpd:rclone-test-lipeqij4muge/deeper/nonexisting/directory" 2025/11/10 04:10:57 DEBUG : Setting type="ftp" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_TYPE 2025/11/10 04:10:57 DEBUG : Setting host="172.17.0.2" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_HOST 2025/11/10 04:10:57 DEBUG : Setting user="rclone" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_USER 2025/11/10 04:10:57 DEBUG : Setting pass="SUR9qrUeOw_XyVmAxe4XiimtkU-ozW9GhIhSRCXK0Wo" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_PASS 2025/11/10 04:10:57 DEBUG : Setting encoding="BackSlash,Ctl,Del,Dot,RightSpace,Slash,SquareBracket" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_ENCODING 2025/11/10 04:10:57 DEBUG : TestFTPPureftpd: detected overridden config - adding "{qY9KD}" suffix to name 2025/11/10 04:10:57 DEBUG : Setting host="172.17.0.2" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_HOST 2025/11/10 04:10:57 DEBUG : Setting user="rclone" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_USER 2025/11/10 04:10:57 DEBUG : Setting pass="SUR9qrUeOw_XyVmAxe4XiimtkU-ozW9GhIhSRCXK0Wo" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_PASS 2025/11/10 04:10:57 DEBUG : Setting encoding="BackSlash,Ctl,Del,Dot,RightSpace,Slash,SquareBracket" for "TestFTPPureftpd" from environment variable RCLONE_CONFIG_TESTFTPPUREFTPD_ENCODING 2025/11/10 04:10:57 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/deeper/nonexisting/directory: Connecting to FTP server 2025/11/10 04:10:57 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/deeper/nonexisting/directory: dial("tcp","172.17.0.2:21") 2025/11/10 04:10:57 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge/deeper/nonexisting/directory: > dial: conn=172.17.0.1:37924->172.17.0.2: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/11/10 04:10:57 DEBUG : Waiting for deletions to finish 2025/11/10 04:10:57 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:38521") 2025/11/10 04:10:57 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:58506->172.17.0.2:38521, err= 2025/11/10 04:10:57 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:36555") 2025/11/10 04:10:57 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:32942->172.17.0.2:36555, err= 2025/11/10 04:10:57 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:36196") 2025/11/10 04:10:57 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:52520->172.17.0.2:36196, err= 2025/11/10 04:10:57 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:30542") 2025/11/10 04:10:57 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:47426->172.17.0.2:30542, err= 2025/11/10 04:10:57 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:38284") 2025/11/10 04:10:57 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:58362->172.17.0.2:38284, err= 2025/11/10 04:10:57 INFO : hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: Deleted 2025/11/10 04:10:57 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:34925") 2025/11/10 04:10:57 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:37820->172.17.0.2:34925, err= 2025/11/10 04:10:57 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:35596") 2025/11/10 04:10:57 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:32782->172.17.0.2:35596, err= 2025/11/10 04:10:57 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:36994") 2025/11/10 04:10:57 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:45508->172.17.0.2:36994, err= 2025/11/10 04:10:57 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:39744") 2025/11/10 04:10:57 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:42022->172.17.0.2:39744, err= 2025/11/10 04:10:57 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:39154") 2025/11/10 04:10:57 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:58434->172.17.0.2:39154, err= 2025/11/10 04:10:57 DEBUG : removing 1 level 4 directories 2025/11/10 04:10:57 INFO : hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠: Removing directory 2025/11/10 04:10:57 DEBUG : removing 1 level 3 directories 2025/11/10 04:10:57 INFO : hello? sausage/êé/Hello, 世界: Removing directory 2025/11/10 04:10:57 DEBUG : removing 1 level 2 directories 2025/11/10 04:10:57 INFO : hello? sausage/êé: Removing directory 2025/11/10 04:10:57 DEBUG : removing 1 level 1 directories 2025/11/10 04:10:57 INFO : hello? sausage: Removing directory 2025/11/10 04:10:57 DEBUG : removing 1 level 0 directories 2025/11/10 04:10:57 INFO : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: Removing directory 2025/11/10 04:10:57 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:36060") 2025/11/10 04:10:57 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:57552->172.17.0.2:36060, err= 2025/11/10 04:10:57 ERROR : error listing: directory not found 2025/11/10 04:10:57 DEBUG : Waiting for deletions to finish 2025/11/10 04:10:57 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:31019") 2025/11/10 04:10:57 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:37046->172.17.0.2:31019, err= 2025/11/10 04:10:57 ERROR : error listing: directory not found 2025/11/10 04:10:57 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: dial("tcp","172.17.0.2:35108") 2025/11/10 04:10:57 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: > dial: conn=172.17.0.1:33986->172.17.0.2:35108, err= 2025/11/10 04:10:57 ERROR : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: Failed to list "": directory not found 2025/11/10 04:10:57 DEBUG : removing 1 level 0 directories 2025/11/10 04:10:57 INFO : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: Removing directory 2025/11/10 04:10:57 ERROR : Failed to rmdir: directory not found === RUN TestIntegration/FsShutdown 2025/11/10 04:10:57 DEBUG : ftp://172.17.0.2:21/rclone-test-lipeqij4muge: closing 2 unused connections 2025/11/10 04:10:57 NOTICE: TestFTPPureftpd: Stopping server --- PASS: TestIntegration (3.58s) --- 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.46s) --- 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.12s) --- PASS: TestIntegration/FsMkdir/FsEncoding/control_chars (0.01s) --- PASS: TestIntegration/FsMkdir/FsEncoding/dot (0.00s) --- PASS: TestIntegration/FsMkdir/FsEncoding/dot_dot (0.00s) --- PASS: TestIntegration/FsMkdir/FsEncoding/punctuation (0.01s) --- PASS: TestIntegration/FsMkdir/FsEncoding/leading_space (0.01s) --- PASS: TestIntegration/FsMkdir/FsEncoding/leading_tilde (0.01s) --- PASS: TestIntegration/FsMkdir/FsEncoding/leading_CR (0.01s) --- PASS: TestIntegration/FsMkdir/FsEncoding/leading_LF (0.01s) --- PASS: TestIntegration/FsMkdir/FsEncoding/leading_HT (0.01s) --- PASS: TestIntegration/FsMkdir/FsEncoding/leading_VT (0.01s) --- PASS: TestIntegration/FsMkdir/FsEncoding/leading_dot (0.01s) --- PASS: TestIntegration/FsMkdir/FsEncoding/trailing_space (0.01s) --- PASS: TestIntegration/FsMkdir/FsEncoding/trailing_CR (0.01s) --- PASS: TestIntegration/FsMkdir/FsEncoding/trailing_LF (0.01s) --- PASS: TestIntegration/FsMkdir/FsEncoding/trailing_HT (0.01s) --- PASS: TestIntegration/FsMkdir/FsEncoding/trailing_VT (0.01s) --- PASS: TestIntegration/FsMkdir/FsEncoding/trailing_dot (0.01s) --- PASS: TestIntegration/FsMkdir/FsEncoding/invalid_UTF-8 (0.01s) --- PASS: TestIntegration/FsMkdir/FsEncoding/URL_encoding (0.01s) --- 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.24s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListDirFile2 (0.00s) --- 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.01s) --- 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.01s) --- 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.06s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FsCopy (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsMove (0.06s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FsMove/Metadata (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsDirMove (0.05s) --- 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.01s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FromRoot/ListEntries (0.00s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FromRoot/ListR (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FromRoot/Put (0.02s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FromRoot/Put/Remove (0.01s) --- 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.01s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/ObjectAbout (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsPutStream (0.01s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsPutStream/0 (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsPutStream/100 (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/Internal (0.85s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/Internal/UploadTimeout (0.85s) --- 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.01s) --- 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 3.601s "go test -v -timeout 1h0m0s -remote TestFTPPureftpd: -verbose" - Finished OK in 4.460009292s (try 1/5)