"go test -v -timeout 1h0m0s -remote TestFTPProftpd: -verbose" - Starting (try 1/5) === RUN TestIntegration fstests.go:438: Using remote "TestFTPProftpd:" 2025/09/09 05:02:34 DEBUG : Creating backend with remote "TestFTPProftpd:rclone-test-debevov2sula" 2025/09/09 05:02:34 DEBUG : Using config file from "/home/rclone/.rclone.conf" 2025/09/09 05:02:34 DEBUG : Setting type="ftp" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_TYPE 2025/09/09 05:02:34 DEBUG : Setting host="172.17.0.4" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2025/09/09 05:02:34 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2025/09/09 05:02:34 DEBUG : Setting pass="AhSYstJc-7rKx2TNN40rGY7Q9SRso0eCaECyiUJXzWbaMw" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2025/09/09 05:02:34 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2025/09/09 05:02:34 DEBUG : TestFTPProftpd: detected overridden config - adding "{owHsH}" suffix to name 2025/09/09 05:02:34 DEBUG : Setting host="172.17.0.4" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2025/09/09 05:02:34 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2025/09/09 05:02:34 DEBUG : Setting pass="AhSYstJc-7rKx2TNN40rGY7Q9SRso0eCaECyiUJXzWbaMw" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2025/09/09 05:02:34 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: Connecting to FTP server 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:21") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:49450->172.17.0.4:21, err= 2025/09/09 05:02:34 DEBUG : Setting type="ftp" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_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/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:26834") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:45154->172.17.0.4:26834, err= === RUN TestIntegration/FsString === RUN TestIntegration/FsName === RUN TestIntegration/FsRoot === RUN TestIntegration/FsRmdirEmpty === RUN TestIntegration/FsMkdir 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:39084") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:49254->172.17.0.4:39084, err= === RUN TestIntegration/FsMkdir/FsMkdirRmdirSubdir 2025/09/09 05:02:34 INFO : dir/subdir: Making directory 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:54587") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:38986->172.17.0.4:54587, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:24962") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:53110->172.17.0.4:24962, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:18620") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:58492->172.17.0.4:18620, err= 2025/09/09 05:02:34 INFO : dir/subdir: Removing directory 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:34097") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:43322->172.17.0.4:34097, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:32511") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:41464->172.17.0.4:32511, err= 2025/09/09 05:02:34 INFO : dir: Removing directory 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:13260") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:48220->172.17.0.4:13260, err= === RUN TestIntegration/FsMkdir/FsListEmpty 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:42913") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:35980->172.17.0.4:42913, err= === RUN TestIntegration/FsMkdir/FsListDirEmpty 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:29009") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:58646->172.17.0.4:29009, err= === RUN TestIntegration/FsMkdir/FsListRDirEmpty fstests.go:399: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsListDirNotFound 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:63589") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:40424->172.17.0.4:63589, err= 2025/09/09 05:02:34 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/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:59196") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:39376->172.17.0.4:59196, err= === RUN TestIntegration/FsMkdir/FsEncoding/control_chars fstests.go:707: testing "␀␁␂␃␄␅␆␇␈␉␊␋␌␍␎␏␐␑␒␓␔␕␖␗␘␙␚␛␜␝␞␟␡" 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:38978") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:33618->172.17.0.4:38978, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:38023") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:40884->172.17.0.4:38023, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:61304") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:40704->172.17.0.4:61304, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:52799") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:53460->172.17.0.4:52799, err= === RUN TestIntegration/FsMkdir/FsEncoding/dot fstests.go:707: testing "." 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:10967") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:53620->172.17.0.4:10967, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:53560") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:57088->172.17.0.4:53560, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:31364") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:43450->172.17.0.4:31364, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:17157") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:41902->172.17.0.4:17157, err= === RUN TestIntegration/FsMkdir/FsEncoding/dot_dot fstests.go:707: testing ".." 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:47763") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:35654->172.17.0.4:47763, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:18488") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:41116->172.17.0.4:18488, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:28525") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:40360->172.17.0.4:28525, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:63589") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:40434->172.17.0.4:63589, err= === RUN TestIntegration/FsMkdir/FsEncoding/punctuation fstests.go:707: testing "!\"#$%&'()*+,-./:;<=>?@[\\]^_`{|}~" 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:7730") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:48724->172.17.0.4:7730, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:46960") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:36240->172.17.0.4:46960, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:35797") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:53068->172.17.0.4:35797, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:7921") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:48494->172.17.0.4:7921, err= === RUN TestIntegration/FsMkdir/FsEncoding/leading_space fstests.go:707: testing " leading space" 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:62143") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:47544->172.17.0.4:62143, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:3479") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:57846->172.17.0.4:3479, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:54395") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:51874->172.17.0.4:54395, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:23443") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:44694->172.17.0.4:23443, err= === RUN TestIntegration/FsMkdir/FsEncoding/leading_tilde fstests.go:707: testing "~leading tilde" 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:41539") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:44004->172.17.0.4:41539, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:43447") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:56308->172.17.0.4:43447, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:47381") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:44534->172.17.0.4:47381, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:59136") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:51014->172.17.0.4:59136, err= === RUN TestIntegration/FsMkdir/FsEncoding/leading_CR fstests.go:707: testing "␍leading CR" 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:12010") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:54092->172.17.0.4:12010, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:14358") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:52020->172.17.0.4:14358, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:6861") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:38476->172.17.0.4:6861, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:53899") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:44938->172.17.0.4:53899, err= === RUN TestIntegration/FsMkdir/FsEncoding/leading_LF fstests.go:707: testing "␊leading LF" 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:42343") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:59390->172.17.0.4:42343, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:4916") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:39816->172.17.0.4:4916, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:47561") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:59548->172.17.0.4:47561, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:15787") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:60266->172.17.0.4:15787, err= === RUN TestIntegration/FsMkdir/FsEncoding/leading_HT fstests.go:707: testing "␉leading HT" 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:41915") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:51278->172.17.0.4:41915, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:43331") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:44142->172.17.0.4:43331, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:3051") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:44904->172.17.0.4:3051, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:51859") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:47526->172.17.0.4:51859, err= === RUN TestIntegration/FsMkdir/FsEncoding/leading_VT fstests.go:707: testing "␋leading VT" 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:31356") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:37770->172.17.0.4:31356, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:33392") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:52300->172.17.0.4:33392, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:3481") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:53350->172.17.0.4:3481, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:13585") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:38070->172.17.0.4:13585, err= === RUN TestIntegration/FsMkdir/FsEncoding/leading_dot fstests.go:707: testing ".leading dot" 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:50856") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:47988->172.17.0.4:50856, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:30982") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:47704->172.17.0.4:30982, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:11639") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:38378->172.17.0.4:11639, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:57562") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:54242->172.17.0.4:57562, err= === RUN TestIntegration/FsMkdir/FsEncoding/trailing_space fstests.go:707: testing "trailing space " 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:12407") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:58788->172.17.0.4:12407, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:46413") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:36040->172.17.0.4:46413, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:64460") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:54844->172.17.0.4:64460, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:9016") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:58136->172.17.0.4:9016, err= === RUN TestIntegration/FsMkdir/FsEncoding/trailing_CR fstests.go:707: testing "trailing CR␍" 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:48868") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:38782->172.17.0.4:48868, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:53320") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:45010->172.17.0.4:53320, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:31436") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:45514->172.17.0.4:31436, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:24872") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:42690->172.17.0.4:24872, err= === RUN TestIntegration/FsMkdir/FsEncoding/trailing_LF fstests.go:707: testing "trailing LF␊" 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:31233") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:38932->172.17.0.4:31233, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:13283") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:43884->172.17.0.4:13283, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:18473") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:49776->172.17.0.4:18473, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:42220") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:45466->172.17.0.4:42220, err= === RUN TestIntegration/FsMkdir/FsEncoding/trailing_HT fstests.go:707: testing "trailing HT␉" 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:26617") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:45640->172.17.0.4:26617, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:24311") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:57974->172.17.0.4:24311, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:30584") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:55792->172.17.0.4:30584, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:3426") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:58660->172.17.0.4:3426, err= === RUN TestIntegration/FsMkdir/FsEncoding/trailing_VT fstests.go:707: testing "trailing VT␋" 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:28203") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:47534->172.17.0.4:28203, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:12611") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:56002->172.17.0.4:12611, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:18189") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:33746->172.17.0.4:18189, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:4584") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:54398->172.17.0.4:4584, err= === RUN TestIntegration/FsMkdir/FsEncoding/trailing_dot fstests.go:707: testing "trailing dot." 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:54918") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:38598->172.17.0.4:54918, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:20216") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:40850->172.17.0.4:20216, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:55419") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:56260->172.17.0.4:55419, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:20740") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:34438->172.17.0.4:20740, err= === RUN TestIntegration/FsMkdir/FsEncoding/invalid_UTF-8 fstests.go:707: testing "invalid utf-8\xfe" 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:52584") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:37646->172.17.0.4:52584, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:57876") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:55662->172.17.0.4:57876, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:33302") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:55212->172.17.0.4:33302, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:37906") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:36062->172.17.0.4:37906, err= === RUN TestIntegration/FsMkdir/FsEncoding/URL_encoding fstests.go:707: testing "test%46.txt" 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:23324") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:52402->172.17.0.4:23324, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:43917") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:34962->172.17.0.4:43917, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:29933") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:42536->172.17.0.4:29933, err= 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:34708") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:54302->172.17.0.4:34708, err= === RUN TestIntegration/FsMkdir/FsNewObjectNotFound === RUN TestIntegration/FsMkdir/FsPutError 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:24795") 2025/09/09 05:02:34 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:40108->172.17.0.4:24795, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: Connecting to FTP server 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:21") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:49456->172.17.0.4:21, err= 2025/09/09 05:02:35 DEBUG : hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: Removed after failed upload: 1 error occurred: * potato === RUN TestIntegration/FsMkdir/FsPutZeroLength 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:28841") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:50774->172.17.0.4:28841, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:53150") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:60698->172.17.0.4:53150, 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/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:58941") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:47876->172.17.0.4:58941, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:52674") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:58278->172.17.0.4:52674, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:34113") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:59626->172.17.0.4:34113, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsListDirFile2 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:40661") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:52198->172.17.0.4:40661, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:22386") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:57244->172.17.0.4:22386, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:31141") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:40078->172.17.0.4:31141, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:25516") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:52256->172.17.0.4:25516, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:12863") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:42176->172.17.0.4:12863, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsListRDirFile2 fstests.go:399: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsPutFiles/FsListR 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:48718") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:54446->172.17.0.4:48718, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:43388") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:49236->172.17.0.4:43388, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:37678") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:51324->172.17.0.4:37678, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:48935") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:54286->172.17.0.4:48935, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:14193") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:37094->172.17.0.4:14193, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsListRSubdir 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:24263") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:58238->172.17.0.4:24263, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:21472") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:39008->172.17.0.4:21472, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:16782") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:50360->172.17.0.4:16782, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:41693") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:46202->172.17.0.4:41693, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsListDirRoot 2025/09/09 05:02:35 DEBUG : Creating backend with remote "TestFTPProftpd:" 2025/09/09 05:02:35 DEBUG : Setting type="ftp" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_TYPE 2025/09/09 05:02:35 DEBUG : Setting host="172.17.0.4" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2025/09/09 05:02:35 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2025/09/09 05:02:35 DEBUG : Setting pass="AhSYstJc-7rKx2TNN40rGY7Q9SRso0eCaECyiUJXzWbaMw" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2025/09/09 05:02:35 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2025/09/09 05:02:35 DEBUG : TestFTPProftpd: detected overridden config - adding "{owHsH}" suffix to name 2025/09/09 05:02:35 DEBUG : Setting host="172.17.0.4" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2025/09/09 05:02:35 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2025/09/09 05:02:35 DEBUG : Setting pass="AhSYstJc-7rKx2TNN40rGY7Q9SRso0eCaECyiUJXzWbaMw" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2025/09/09 05:02:35 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: Connecting to FTP server 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:21") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:49468->172.17.0.4:21, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:52562") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:35200->172.17.0.4:52562, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsListRDirRoot fstests.go:399: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsPutFiles/FsListSubdir 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:28574") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:36554->172.17.0.4:28574, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:57419") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:46360->172.17.0.4:57419, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsListRSubdir#01 fstests.go:399: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsPutFiles/FsListLevel2 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:58738") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:55502->172.17.0.4:58738, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:45443") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:48350->172.17.0.4:45443, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsListRLevel2 fstests.go:399: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsPutFiles/FsListFile1 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:28333") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:54926->172.17.0.4:28333, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:44862") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:55322->172.17.0.4:44862, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:10872") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:51394->172.17.0.4:10872, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:51002") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:36028->172.17.0.4:51002, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:36200") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:56574->172.17.0.4:36200, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsNewObject === RUN TestIntegration/FsMkdir/FsPutFiles/FsNewObjectCaseInsensitive fstests.go:1121: Not Case Insensitive === RUN TestIntegration/FsMkdir/FsPutFiles/FsListFile1and2 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:53496") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:56774->172.17.0.4:53496, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:16898") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:45018->172.17.0.4:16898, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:29260") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:59058->172.17.0.4:29260, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:16803") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:48634->172.17.0.4:16803, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:4513") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:49564->172.17.0.4:4513, 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/09/09 05:02:35 DEBUG : Creating backend with remote "TestFTPProftpd:rclone-test-debevov2sula/hello? sausage/êé" 2025/09/09 05:02:35 DEBUG : Setting type="ftp" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_TYPE 2025/09/09 05:02:35 DEBUG : Setting host="172.17.0.4" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2025/09/09 05:02:35 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2025/09/09 05:02:35 DEBUG : Setting pass="AhSYstJc-7rKx2TNN40rGY7Q9SRso0eCaECyiUJXzWbaMw" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2025/09/09 05:02:35 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2025/09/09 05:02:35 DEBUG : TestFTPProftpd: detected overridden config - adding "{owHsH}" suffix to name 2025/09/09 05:02:35 DEBUG : Setting host="172.17.0.4" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2025/09/09 05:02:35 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2025/09/09 05:02:35 DEBUG : Setting pass="AhSYstJc-7rKx2TNN40rGY7Q9SRso0eCaECyiUJXzWbaMw" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2025/09/09 05:02:35 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: Connecting to FTP server 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: dial("tcp","172.17.0.4:21") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: > dial: conn=172.17.0.1:49472->172.17.0.4:21, err= 2025/09/09 05:02:35 DEBUG : fs cache: renaming cache item "TestFTPProftpd:rclone-test-debevov2sula/hello? sausage/êé" to be canonical "TestFTPProftpd{owHsH}:rclone-test-debevov2sula/hello? sausage/êé" 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: dial("tcp","172.17.0.4:44463") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: > dial: conn=172.17.0.1:39186->172.17.0.4:44463, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: dial("tcp","172.17.0.4:33801") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: > dial: conn=172.17.0.1:38744->172.17.0.4:33801, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: Connecting to FTP server 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: dial("tcp","172.17.0.4:21") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: dial("tcp","172.17.0.4:43917") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: > dial: conn=172.17.0.1:49484->172.17.0.4:21, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: > dial: conn=172.17.0.1:34968->172.17.0.4:43917, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: dial("tcp","172.17.0.4:54837") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: > dial: conn=172.17.0.1:57410->172.17.0.4:54837, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: dial("tcp","172.17.0.4:47007") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: > dial: conn=172.17.0.1:56012->172.17.0.4:47007, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: dial("tcp","172.17.0.4:6070") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: > dial: conn=172.17.0.1:46674->172.17.0.4:6070, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: dial("tcp","172.17.0.4:54580") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: > dial: conn=172.17.0.1:42466->172.17.0.4:54580, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: dial("tcp","172.17.0.4:9231") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: > dial: conn=172.17.0.1:33400->172.17.0.4:9231, err= 2025/09/09 05:02:35 DEBUG : Waiting for deletions to finish 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: dial("tcp","172.17.0.4:3006") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: > dial: conn=172.17.0.1:59950->172.17.0.4:3006, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: dial("tcp","172.17.0.4:56193") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: > dial: conn=172.17.0.1:53444->172.17.0.4:56193, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: dial("tcp","172.17.0.4:45825") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: > dial: conn=172.17.0.1:53526->172.17.0.4:45825, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: dial("tcp","172.17.0.4:59095") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: > dial: conn=172.17.0.1:57668->172.17.0.4:59095, err= 2025/09/09 05:02:35 INFO : a/b/c/d/e.txt: Deleted 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: dial("tcp","172.17.0.4:30951") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: > dial: conn=172.17.0.1:48722->172.17.0.4:30951, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: dial("tcp","172.17.0.4:64061") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: > dial: conn=172.17.0.1:46608->172.17.0.4:64061, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: dial("tcp","172.17.0.4:61885") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: > dial: conn=172.17.0.1:41540->172.17.0.4:61885, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: dial("tcp","172.17.0.4:3404") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé: > dial: conn=172.17.0.1:56404->172.17.0.4:3404, err= 2025/09/09 05:02:35 DEBUG : removing 1 level 4 directories 2025/09/09 05:02:35 INFO : a/b/c/d: Removing directory 2025/09/09 05:02:35 DEBUG : removing 1 level 3 directories 2025/09/09 05:02:35 INFO : a/b/c: Removing directory 2025/09/09 05:02:35 DEBUG : removing 1 level 2 directories 2025/09/09 05:02:35 INFO : a/b: Removing directory 2025/09/09 05:02:35 DEBUG : removing 1 level 1 directories 2025/09/09 05:02:35 INFO : a: Removing directory === RUN TestIntegration/FsMkdir/FsPutFiles/FsCopy fstests.go:1254: FS has no Copier interface === RUN TestIntegration/FsMkdir/FsPutFiles/FsMove 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:22667") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:53854->172.17.0.4:22667, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:3942") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:37480->172.17.0.4:3942, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:37603") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:55064->172.17.0.4:37603, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:62304") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:54414->172.17.0.4:62304, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:25305") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:37290->172.17.0.4:25305, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:3209") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:40986->172.17.0.4:3209, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: Connecting to FTP server 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:21") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:49490->172.17.0.4:21, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:22285") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:50666->172.17.0.4:22285, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:58226") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:42724->172.17.0.4:58226, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:37145") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:59318->172.17.0.4:37145, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:54799") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:39680->172.17.0.4:54799, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:50904") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:46002->172.17.0.4:50904, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:48535") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:39254->172.17.0.4:48535, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:64650") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:41590->172.17.0.4:64650, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:36532") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:60586->172.17.0.4:36532, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:9288") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:59072->172.17.0.4:9288, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:40262") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:42176->172.17.0.4:40262, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:34305") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:36134->172.17.0.4:34305, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:14707") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:57156->172.17.0.4:14707, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:13309") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:43643") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:60388->172.17.0.4:13309, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:55590->172.17.0.4:43643, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:21584") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:38018->172.17.0.4:21584, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:32527") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:52154->172.17.0.4:32527, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:8406") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:53470->172.17.0.4:8406, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsMove/Metadata fstests.go:1398: Skipping test as can't write metadata === RUN TestIntegration/FsMkdir/FsPutFiles/FsDirMove 2025/09/09 05:02:35 DEBUG : Creating backend with remote "TestFTPProftpd:rclone-test-kozihig5waki" 2025/09/09 05:02:35 DEBUG : Setting type="ftp" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_TYPE 2025/09/09 05:02:35 DEBUG : Setting host="172.17.0.4" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2025/09/09 05:02:35 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2025/09/09 05:02:35 DEBUG : Setting pass="AhSYstJc-7rKx2TNN40rGY7Q9SRso0eCaECyiUJXzWbaMw" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2025/09/09 05:02:35 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2025/09/09 05:02:35 DEBUG : TestFTPProftpd: detected overridden config - adding "{owHsH}" suffix to name 2025/09/09 05:02:35 DEBUG : Setting host="172.17.0.4" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2025/09/09 05:02:35 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2025/09/09 05:02:35 DEBUG : Setting pass="AhSYstJc-7rKx2TNN40rGY7Q9SRso0eCaECyiUJXzWbaMw" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2025/09/09 05:02:35 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-kozihig5waki: Connecting to FTP server 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-kozihig5waki: dial("tcp","172.17.0.4:21") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-kozihig5waki: > dial: conn=172.17.0.1:49494->172.17.0.4:21, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:54753") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:46158->172.17.0.4:54753, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-kozihig5waki: dial("tcp","172.17.0.4:27443") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-kozihig5waki: > dial: conn=172.17.0.1:46940->172.17.0.4:27443, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-kozihig5waki: dial("tcp","172.17.0.4:24400") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-kozihig5waki: > dial: conn=172.17.0.1:40930->172.17.0.4:24400, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-kozihig5waki: dial("tcp","172.17.0.4:56915") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-kozihig5waki: > dial: conn=172.17.0.1:43606->172.17.0.4:56915, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-kozihig5waki: dial("tcp","172.17.0.4:19172") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-kozihig5waki: > dial: conn=172.17.0.1:57486->172.17.0.4:19172, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-kozihig5waki: dial("tcp","172.17.0.4:59001") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-kozihig5waki: > dial: conn=172.17.0.1:47294->172.17.0.4:59001, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-kozihig5waki: dial("tcp","172.17.0.4:42449") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-kozihig5waki: > dial: conn=172.17.0.1:59590->172.17.0.4:42449, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-kozihig5waki: dial("tcp","172.17.0.4:1926") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-kozihig5waki: > dial: conn=172.17.0.1:46348->172.17.0.4:1926, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:21954") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:40276->172.17.0.4:21954, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:29067") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:49958->172.17.0.4:29067, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:62432") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:54242->172.17.0.4:62432, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:8686") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:33352->172.17.0.4:8686, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:21793") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:36946->172.17.0.4:21793, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-kozihig5waki: dial("tcp","172.17.0.4:31204") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-kozihig5waki: > dial: conn=172.17.0.1:47676->172.17.0.4:31204, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-kozihig5waki: dial("tcp","172.17.0.4:7263") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-kozihig5waki: > dial: conn=172.17.0.1:57318->172.17.0.4:7263, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-kozihig5waki: dial("tcp","172.17.0.4:30300") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-kozihig5waki: > dial: conn=172.17.0.1:59362->172.17.0.4:30300, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-kozihig5waki: dial("tcp","172.17.0.4:51319") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-kozihig5waki: > dial: conn=172.17.0.1:36740->172.17.0.4:51319, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-kozihig5waki: Purge dir "new_name" 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-kozihig5waki: 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/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:17793") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:52818->172.17.0.4:17793, err= === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectOpenSeek 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:20951") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:33550->172.17.0.4:20951, err= === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectOpenRange 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:1890") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:53988->172.17.0.4:1890, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:42561") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:59432->172.17.0.4:42561, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:62212") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:58108->172.17.0.4:62212, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:49953") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:59052->172.17.0.4:49953, err= === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectPartialRead 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:51126") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:49848->172.17.0.4:51126, err= === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectUpdate 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:12865") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:36402->172.17.0.4:12865, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:15271") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:49402->172.17.0.4:15271, err= === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectStorable === RUN TestIntegration/FsMkdir/FsPutFiles/FsIsFile 2025/09/09 05:02:35 DEBUG : Creating backend with remote "TestFTPProftpd:rclone-test-debevov2sula/hello? sausage/êé/Hello, 世界/ \" ' @ < > & ? + ≠/z.txt" 2025/09/09 05:02:35 DEBUG : Setting type="ftp" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_TYPE 2025/09/09 05:02:35 DEBUG : Setting host="172.17.0.4" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2025/09/09 05:02:35 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2025/09/09 05:02:35 DEBUG : Setting pass="AhSYstJc-7rKx2TNN40rGY7Q9SRso0eCaECyiUJXzWbaMw" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2025/09/09 05:02:35 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2025/09/09 05:02:35 DEBUG : TestFTPProftpd: detected overridden config - adding "{owHsH}" suffix to name 2025/09/09 05:02:35 DEBUG : Setting host="172.17.0.4" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2025/09/09 05:02:35 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2025/09/09 05:02:35 DEBUG : Setting pass="AhSYstJc-7rKx2TNN40rGY7Q9SRso0eCaECyiUJXzWbaMw" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2025/09/09 05:02:35 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: Connecting to FTP server 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: dial("tcp","172.17.0.4:21") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: > dial: conn=172.17.0.1:46092->172.17.0.4:21, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsIsFile/FsRoot 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: dial("tcp","172.17.0.4:17815") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: > dial: conn=172.17.0.1:38452->172.17.0.4:17815, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsIsFileNotFound 2025/09/09 05:02:35 DEBUG : Creating backend with remote "TestFTPProftpd:rclone-test-debevov2sula/not found.txt" 2025/09/09 05:02:35 DEBUG : Setting type="ftp" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_TYPE 2025/09/09 05:02:35 DEBUG : Setting host="172.17.0.4" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2025/09/09 05:02:35 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2025/09/09 05:02:35 DEBUG : Setting pass="AhSYstJc-7rKx2TNN40rGY7Q9SRso0eCaECyiUJXzWbaMw" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2025/09/09 05:02:35 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2025/09/09 05:02:35 DEBUG : TestFTPProftpd: detected overridden config - adding "{owHsH}" suffix to name 2025/09/09 05:02:35 DEBUG : Setting host="172.17.0.4" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2025/09/09 05:02:35 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2025/09/09 05:02:35 DEBUG : Setting pass="AhSYstJc-7rKx2TNN40rGY7Q9SRso0eCaECyiUJXzWbaMw" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2025/09/09 05:02:35 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/not found.txt: Connecting to FTP server 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/not found.txt: dial("tcp","172.17.0.4:21") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/not found.txt: > dial: conn=172.17.0.1:46106->172.17.0.4:21, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/not found.txt: dial("tcp","172.17.0.4:8150") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/not found.txt: > dial: conn=172.17.0.1:40638->172.17.0.4:8150, err= 2025/09/09 05:02:35 ERROR : error listing: directory not found === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot fstests.go:1911: Opening root remote "TestFTPProftpd:" path "rclone-test-debevov2sula" from "TestFTPProftpd:rclone-test-debevov2sula" 2025/09/09 05:02:35 DEBUG : Creating backend with remote "TestFTPProftpd:" 2025/09/09 05:02:35 DEBUG : Setting type="ftp" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_TYPE 2025/09/09 05:02:35 DEBUG : Setting host="172.17.0.4" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2025/09/09 05:02:35 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2025/09/09 05:02:35 DEBUG : Setting pass="AhSYstJc-7rKx2TNN40rGY7Q9SRso0eCaECyiUJXzWbaMw" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2025/09/09 05:02:35 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2025/09/09 05:02:35 DEBUG : TestFTPProftpd: detected overridden config - adding "{owHsH}" suffix to name 2025/09/09 05:02:35 DEBUG : Setting host="172.17.0.4" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2025/09/09 05:02:35 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2025/09/09 05:02:35 DEBUG : Setting pass="AhSYstJc-7rKx2TNN40rGY7Q9SRso0eCaECyiUJXzWbaMw" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2025/09/09 05:02:35 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: Connecting to FTP server 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:21") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:46122->172.17.0.4:21, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot/List 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:18022") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:42312->172.17.0.4:18022, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:42116") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:56620->172.17.0.4:42116, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:11494") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:42342->172.17.0.4:11494, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:3028") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:55518->172.17.0.4:3028, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:15039") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:50950->172.17.0.4:15039, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot/ListEntries 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:11226") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:35108->172.17.0.4:11226, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot/ListR fstests.go:1945: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot/Put 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:24880") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:35292->172.17.0.4:24880, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:17888") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:51406->172.17.0.4:17888, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:10309") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:44050->172.17.0.4:10309, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:25187") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:40656->172.17.0.4:25187, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:26002") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:51018->172.17.0.4:26002, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:60360") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:37546->172.17.0.4:60360, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot/Put/Remove 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:50784") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:57422->172.17.0.4:50784, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:61511") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:41670->172.17.0.4:61511, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:22003") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:39090->172.17.0.4:22003, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:50802") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:55886->172.17.0.4:50802, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:12795") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:58780->172.17.0.4:12795, 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/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:48260") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:51750->172.17.0.4:48260, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:55373") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:33812->172.17.0.4:55373, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:45728") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:51918->172.17.0.4:45728, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:60305") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:38894->172.17.0.4:60305, err= 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:7550") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:40676->172.17.0.4:7550, 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/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:33728") 2025/09/09 05:02:35 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:46312->172.17.0.4:33728, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsPutStream/100 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:7421") 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:38628->172.17.0.4:7421, err= === RUN TestIntegration/FsMkdir/FsPutFiles/Internal === RUN TestIntegration/FsMkdir/FsPutFiles/Internal/UploadTimeout 2025/09/09 05:02:36 DEBUG : Creating backend with remote "TestFTPProftpd,concurrency='0',shut_timeout='1s':rclone-test-debevov2sula" 2025/09/09 05:02:36 DEBUG : Setting type="ftp" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_TYPE 2025/09/09 05:02:36 DEBUG : Setting host="172.17.0.4" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2025/09/09 05:02:36 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2025/09/09 05:02:36 DEBUG : Setting pass="AhSYstJc-7rKx2TNN40rGY7Q9SRso0eCaECyiUJXzWbaMw" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2025/09/09 05:02:36 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2025/09/09 05:02:36 DEBUG : TestFTPProftpd: detected overridden config - adding "{s5IkU}" suffix to name 2025/09/09 05:02:36 DEBUG : Setting host="172.17.0.4" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2025/09/09 05:02:36 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2025/09/09 05:02:36 DEBUG : Setting pass="AhSYstJc-7rKx2TNN40rGY7Q9SRso0eCaECyiUJXzWbaMw" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2025/09/09 05:02:36 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: Connecting to FTP server 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:21") 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:46124->172.17.0.4:21, err= 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:21175") 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:45318->172.17.0.4:21175, 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/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:16394") 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:39358->172.17.0.4:16394, err= === RUN TestIntegration/FsMkdir/FsUploadUnknownSize/FsUpdateUnknownSize 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:60022") 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:33948->172.17.0.4:60022, err= 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:31188") 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:40032->172.17.0.4:31188, err= === RUN TestIntegration/FsMkdir/FsRootCollapse 2025/09/09 05:02:36 DEBUG : Creating backend with remote "TestFTPProftpd:rclone-test-debevov2sula/deeper/nonexisting/directory" 2025/09/09 05:02:36 DEBUG : Setting type="ftp" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_TYPE 2025/09/09 05:02:36 DEBUG : Setting host="172.17.0.4" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2025/09/09 05:02:36 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2025/09/09 05:02:36 DEBUG : Setting pass="AhSYstJc-7rKx2TNN40rGY7Q9SRso0eCaECyiUJXzWbaMw" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2025/09/09 05:02:36 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2025/09/09 05:02:36 DEBUG : TestFTPProftpd: detected overridden config - adding "{owHsH}" suffix to name 2025/09/09 05:02:36 DEBUG : Setting host="172.17.0.4" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2025/09/09 05:02:36 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2025/09/09 05:02:36 DEBUG : Setting pass="AhSYstJc-7rKx2TNN40rGY7Q9SRso0eCaECyiUJXzWbaMw" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2025/09/09 05:02:36 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/deeper/nonexisting/directory: Connecting to FTP server 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/deeper/nonexisting/directory: dial("tcp","172.17.0.4:21") 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula/deeper/nonexisting/directory: > dial: conn=172.17.0.1:46140->172.17.0.4: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/09/09 05:02:36 DEBUG : Waiting for deletions to finish 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:49602") 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:33260->172.17.0.4:49602, err= 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:21027") 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:57234->172.17.0.4:21027, err= 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:44630") 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:37414->172.17.0.4:44630, err= 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:16388") 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:60554->172.17.0.4:16388, err= 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:11290") 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:58796->172.17.0.4:11290, err= 2025/09/09 05:02:36 INFO : hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: Deleted 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:6883") 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:49424->172.17.0.4:6883, err= 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:53092") 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:34156->172.17.0.4:53092, err= 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:4783") 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:33668->172.17.0.4:4783, err= 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:1762") 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:48990->172.17.0.4:1762, err= 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:29446") 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:51892->172.17.0.4:29446, err= 2025/09/09 05:02:36 DEBUG : removing 1 level 4 directories 2025/09/09 05:02:36 INFO : hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠: Removing directory 2025/09/09 05:02:36 DEBUG : removing 1 level 3 directories 2025/09/09 05:02:36 INFO : hello? sausage/êé/Hello, 世界: Removing directory 2025/09/09 05:02:36 DEBUG : removing 1 level 2 directories 2025/09/09 05:02:36 INFO : hello? sausage/êé: Removing directory 2025/09/09 05:02:36 DEBUG : removing 1 level 1 directories 2025/09/09 05:02:36 INFO : hello? sausage: Removing directory 2025/09/09 05:02:36 DEBUG : removing 1 level 0 directories 2025/09/09 05:02:36 INFO : ftp://172.17.0.4:21/rclone-test-debevov2sula: Removing directory 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:17269") 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:54742->172.17.0.4:17269, err= 2025/09/09 05:02:36 ERROR : error listing: directory not found 2025/09/09 05:02:36 DEBUG : Waiting for deletions to finish 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:14209") 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:52182->172.17.0.4:14209, err= 2025/09/09 05:02:36 ERROR : error listing: directory not found 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: dial("tcp","172.17.0.4:20888") 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: > dial: conn=172.17.0.1:47142->172.17.0.4:20888, err= 2025/09/09 05:02:36 ERROR : ftp://172.17.0.4:21/rclone-test-debevov2sula: Failed to list "": directory not found 2025/09/09 05:02:36 DEBUG : removing 1 level 0 directories 2025/09/09 05:02:36 INFO : ftp://172.17.0.4:21/rclone-test-debevov2sula: Removing directory 2025/09/09 05:02:36 ERROR : Failed to rmdir: directory not found === RUN TestIntegration/FsShutdown 2025/09/09 05:02:36 DEBUG : ftp://172.17.0.4:21/rclone-test-debevov2sula: closing 2 unused connections --- PASS: TestIntegration (2.63s) --- 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.56s) --- PASS: TestIntegration/FsMkdir/FsMkdirRmdirSubdir (0.02s) --- 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.17s) --- PASS: TestIntegration/FsMkdir/FsEncoding/control_chars (0.02s) --- PASS: TestIntegration/FsMkdir/FsEncoding/dot (0.01s) --- PASS: TestIntegration/FsMkdir/FsEncoding/dot_dot (0.01s) --- 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.02s) --- PASS: TestIntegration/FsMkdir/FsPutZeroLength (0.01s) --- SKIP: TestIntegration/FsMkdir/FsOpenWriterAt (0.00s) --- SKIP: TestIntegration/FsMkdir/FsOpenChunkWriter (0.00s) --- SKIP: TestIntegration/FsMkdir/FsChangeNotify (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles (1.28s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListDirFile2 (0.02s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FsListRDirFile2 (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListR (0.01s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListRSubdir (0.01s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListDirRoot (0.02s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FsListRDirRoot (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListSubdir (0.01s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FsListRSubdir#01 (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListLevel2 (0.01s) --- 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.09s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FsCopy (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsMove (0.09s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FsMove/Metadata (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsDirMove (0.06s) --- 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.02s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsIsFile/FsRoot (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsIsFileNotFound (0.02s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FromRoot (0.07s) --- 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.04s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FromRoot/Put/Remove (0.02s) --- 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.01s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsPutStream/100 (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/Internal (0.71s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/Internal/UploadTimeout (0.71s) --- 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.01s) --- 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.645s "go test -v -timeout 1h0m0s -remote TestFTPProftpd: -verbose" - Finished OK in 3.477307165s (try 1/5)