"go test -v -timeout 1h0m0s -remote TestFTPProftpd: -verbose" - Starting (try 1/5) === RUN TestIntegration fstests.go:438: Using remote "TestFTPProftpd:" 2026/01/05 04:54:46 NOTICE: TestFTPProftpd: Starting server 2026/01/05 04:54:47 NOTICE: TestFTPProftpd: Attempting to connect to "172.17.0.9:21" try 1/100 2026/01/05 04:54:47 DEBUG : TestFTPProftpd: Read 1, error: 2026/01/05 04:54:47 NOTICE: TestFTPProftpd: Started server and connected to "172.17.0.9:21" 2026/01/05 04:54:47 DEBUG : Creating backend with remote "TestFTPProftpd:rclone-test-ceniciq3gecu" 2026/01/05 04:54:47 DEBUG : Using config file from "/home/rclone/.rclone.conf" 2026/01/05 04:54:47 DEBUG : Setting type="ftp" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_TYPE 2026/01/05 04:54:47 DEBUG : Setting host="172.17.0.9" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2026/01/05 04:54:47 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2026/01/05 04:54:47 DEBUG : Setting pass="RwYKDb3TQOm5-G8-WZGB92gm-EV0vfwkP_TUaWF_M7003A" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2026/01/05 04:54:47 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2026/01/05 04:54:47 DEBUG : TestFTPProftpd: detected overridden config - adding "{8tlHY}" suffix to name 2026/01/05 04:54:47 DEBUG : Setting host="172.17.0.9" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2026/01/05 04:54:47 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2026/01/05 04:54:47 DEBUG : Setting pass="RwYKDb3TQOm5-G8-WZGB92gm-EV0vfwkP_TUaWF_M7003A" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2026/01/05 04:54:47 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: Connecting to FTP server 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:21") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:57960->172.17.0.9:21, err= 2026/01/05 04:54:47 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 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:48362") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:60088->172.17.0.9:48362, err= === RUN TestIntegration/FsString === RUN TestIntegration/FsName === RUN TestIntegration/FsRoot === RUN TestIntegration/FsRmdirEmpty === RUN TestIntegration/FsMkdir 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:64693") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:34010->172.17.0.9:64693, err= === RUN TestIntegration/FsMkdir/FsMkdirRmdirSubdir 2026/01/05 04:54:47 INFO : dir/subdir: Making directory 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:49726") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:59878->172.17.0.9:49726, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:26107") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:37092->172.17.0.9:26107, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:44101") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:37850->172.17.0.9:44101, err= 2026/01/05 04:54:47 INFO : dir/subdir: Removing directory 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:56710") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:46384->172.17.0.9:56710, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:37059") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:53286->172.17.0.9:37059, err= 2026/01/05 04:54:47 INFO : dir: Removing directory 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:57769") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:51990->172.17.0.9:57769, err= === RUN TestIntegration/FsMkdir/FsListEmpty 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:50069") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:56170->172.17.0.9:50069, err= === RUN TestIntegration/FsMkdir/FsListDirEmpty 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:64677") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:38012->172.17.0.9:64677, err= === RUN TestIntegration/FsMkdir/FsListRDirEmpty fstests.go:399: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsListDirNotFound 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:14112") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:50592->172.17.0.9:14112, err= 2026/01/05 04:54:47 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 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:10744") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:36380->172.17.0.9:10744, err= === RUN TestIntegration/FsMkdir/FsEncoding/control_chars fstests.go:707: testing "␀␁␂␃␄␅␆␇␈␉␊␋␌␍␎␏␐␑␒␓␔␕␖␗␘␙␚␛␜␝␞␟␡" 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:49963") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:53710->172.17.0.9:49963, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:50254") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:43600->172.17.0.9:50254, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:12012") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:54968->172.17.0.9:12012, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:64584") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:35852->172.17.0.9:64584, err= === RUN TestIntegration/FsMkdir/FsEncoding/dot fstests.go:707: testing "." 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:32063") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:52134->172.17.0.9:32063, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:34093") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:59634->172.17.0.9:34093, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:17923") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:59000->172.17.0.9:17923, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:30787") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:60574->172.17.0.9:30787, err= === RUN TestIntegration/FsMkdir/FsEncoding/dot_dot fstests.go:707: testing ".." 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:16141") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:43208->172.17.0.9:16141, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:42800") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:36898->172.17.0.9:42800, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:63400") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:33552->172.17.0.9:63400, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:6258") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:50800->172.17.0.9:6258, err= === RUN TestIntegration/FsMkdir/FsEncoding/punctuation fstests.go:707: testing "!\"#$%&'()*+,-./:;<=>?@[\\]^_`{|}~" 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:38749") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:35138->172.17.0.9:38749, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:60741") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:50198->172.17.0.9:60741, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:27280") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:38822->172.17.0.9:27280, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:55813") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:56250->172.17.0.9:55813, err= === RUN TestIntegration/FsMkdir/FsEncoding/leading_space fstests.go:707: testing " leading space" 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:50386") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:33188->172.17.0.9:50386, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:33883") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:59160->172.17.0.9:33883, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:6926") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:44684->172.17.0.9:6926, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:33214") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:40566->172.17.0.9:33214, err= === RUN TestIntegration/FsMkdir/FsEncoding/leading_tilde fstests.go:707: testing "~leading tilde" 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:33041") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:45126->172.17.0.9:33041, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:55628") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:34208->172.17.0.9:55628, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:58298") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:54332->172.17.0.9:58298, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:11607") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:43534->172.17.0.9:11607, err= === RUN TestIntegration/FsMkdir/FsEncoding/leading_CR fstests.go:707: testing "␍leading CR" 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:46803") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:52430->172.17.0.9:46803, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:29822") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:56986->172.17.0.9:29822, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:3842") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:55462->172.17.0.9:3842, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:31338") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:32982->172.17.0.9:31338, err= === RUN TestIntegration/FsMkdir/FsEncoding/leading_LF fstests.go:707: testing "␊leading LF" 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:28965") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:33398->172.17.0.9:28965, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:16930") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:56932->172.17.0.9:16930, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:41058") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:33404->172.17.0.9:41058, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:13393") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:55680->172.17.0.9:13393, err= === RUN TestIntegration/FsMkdir/FsEncoding/leading_HT fstests.go:707: testing "␉leading HT" 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:1650") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:43824->172.17.0.9:1650, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:52047") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:44624->172.17.0.9:52047, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:12443") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:51184->172.17.0.9:12443, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:32689") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:47540->172.17.0.9:32689, err= === RUN TestIntegration/FsMkdir/FsEncoding/leading_VT fstests.go:707: testing "␋leading VT" 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:20606") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:52100->172.17.0.9:20606, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:29342") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:35774->172.17.0.9:29342, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:62452") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:59930->172.17.0.9:62452, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:35723") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:53718->172.17.0.9:35723, err= === RUN TestIntegration/FsMkdir/FsEncoding/leading_dot fstests.go:707: testing ".leading dot" 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:6608") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:58382->172.17.0.9:6608, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:60317") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:37604->172.17.0.9:60317, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:40958") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:36888->172.17.0.9:40958, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:44333") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:37274->172.17.0.9:44333, err= === RUN TestIntegration/FsMkdir/FsEncoding/trailing_space fstests.go:707: testing "trailing space " 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:55524") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:32864->172.17.0.9:55524, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:2703") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:44730->172.17.0.9:2703, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:34612") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:51548->172.17.0.9:34612, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:40376") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:34876->172.17.0.9:40376, err= === RUN TestIntegration/FsMkdir/FsEncoding/trailing_CR fstests.go:707: testing "trailing CR␍" 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:35562") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:40266->172.17.0.9:35562, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:40514") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:42742->172.17.0.9:40514, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:8055") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:43102->172.17.0.9:8055, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:3069") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:38244->172.17.0.9:3069, err= === RUN TestIntegration/FsMkdir/FsEncoding/trailing_LF fstests.go:707: testing "trailing LF␊" 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:30608") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:52578->172.17.0.9:30608, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:65330") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:48770->172.17.0.9:65330, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:13653") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:50358->172.17.0.9:13653, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:11876") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:45976->172.17.0.9:11876, err= === RUN TestIntegration/FsMkdir/FsEncoding/trailing_HT fstests.go:707: testing "trailing HT␉" 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:29617") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:52894->172.17.0.9:29617, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:16471") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:44180->172.17.0.9:16471, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:42191") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:45528->172.17.0.9:42191, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:57559") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:41890->172.17.0.9:57559, err= === RUN TestIntegration/FsMkdir/FsEncoding/trailing_VT fstests.go:707: testing "trailing VT␋" 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:32377") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:35892->172.17.0.9:32377, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:17715") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:47314->172.17.0.9:17715, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:5417") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:54678->172.17.0.9:5417, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:33004") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:53934->172.17.0.9:33004, err= === RUN TestIntegration/FsMkdir/FsEncoding/trailing_dot fstests.go:707: testing "trailing dot." 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:4228") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:55812->172.17.0.9:4228, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:16837") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:54296->172.17.0.9:16837, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:64669") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:52516->172.17.0.9:64669, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:23810") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:60574->172.17.0.9:23810, err= === RUN TestIntegration/FsMkdir/FsEncoding/invalid_UTF-8 fstests.go:707: testing "invalid utf-8\xfe" 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:45156") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:51972->172.17.0.9:45156, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:61587") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:51244->172.17.0.9:61587, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:58510") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:36544->172.17.0.9:58510, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:50740") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:33850->172.17.0.9:50740, err= === RUN TestIntegration/FsMkdir/FsEncoding/URL_encoding fstests.go:707: testing "test%46.txt" 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:56370") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:44820->172.17.0.9:56370, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:33933") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:56996->172.17.0.9:33933, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:29539") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:33436->172.17.0.9:29539, err= 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:46360") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:34848->172.17.0.9:46360, err= === RUN TestIntegration/FsMkdir/FsNewObjectNotFound === RUN TestIntegration/FsMkdir/FsPutError 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:35613") 2026/01/05 04:54:47 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:51448->172.17.0.9:35613, err= 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: Connecting to FTP server 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:21") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:57966->172.17.0.9:21, err= 2026/01/05 04:54:48 DEBUG : hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: Removed after failed upload: 1 error occurred: * potato === RUN TestIntegration/FsMkdir/FsPutZeroLength 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:44160") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:34404->172.17.0.9:44160, err= 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:36860") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:47134->172.17.0.9:36860, 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 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:23533") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:36398->172.17.0.9:23533, err= 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:42413") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:45494->172.17.0.9:42413, err= 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:12028") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:36770->172.17.0.9:12028, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsListDirFile2 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:20747") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:52358->172.17.0.9:20747, err= 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:5010") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:60614->172.17.0.9:5010, err= 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:58811") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:59442->172.17.0.9:58811, err= 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:55821") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:44326->172.17.0.9:55821, err= 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:64856") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:35960->172.17.0.9:64856, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsListRDirFile2 fstests.go:399: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsPutFiles/FsListR 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:13030") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:39416->172.17.0.9:13030, err= 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:21971") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:46044->172.17.0.9:21971, err= 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:58082") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:43048->172.17.0.9:58082, err= 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:62809") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:44086->172.17.0.9:62809, err= 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:48015") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:48914->172.17.0.9:48015, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsListRSubdir 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:26743") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:60620->172.17.0.9:26743, err= 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:34221") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:52488->172.17.0.9:34221, err= 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:23029") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:60804->172.17.0.9:23029, err= 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:37130") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:43626->172.17.0.9:37130, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsListDirRoot 2026/01/05 04:54:48 DEBUG : Creating backend with remote "TestFTPProftpd:" 2026/01/05 04:54:48 DEBUG : Setting type="ftp" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_TYPE 2026/01/05 04:54:48 DEBUG : Setting host="172.17.0.9" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2026/01/05 04:54:48 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2026/01/05 04:54:48 DEBUG : Setting pass="RwYKDb3TQOm5-G8-WZGB92gm-EV0vfwkP_TUaWF_M7003A" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2026/01/05 04:54:48 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2026/01/05 04:54:48 DEBUG : TestFTPProftpd: detected overridden config - adding "{8tlHY}" suffix to name 2026/01/05 04:54:48 DEBUG : Setting host="172.17.0.9" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2026/01/05 04:54:48 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2026/01/05 04:54:48 DEBUG : Setting pass="RwYKDb3TQOm5-G8-WZGB92gm-EV0vfwkP_TUaWF_M7003A" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2026/01/05 04:54:48 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21: Connecting to FTP server 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21: dial("tcp","172.17.0.9:21") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21: > dial: conn=172.17.0.1:57982->172.17.0.9:21, err= 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21: dial("tcp","172.17.0.9:20528") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21: > dial: conn=172.17.0.1:52798->172.17.0.9:20528, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsListRDirRoot fstests.go:399: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsPutFiles/FsListSubdir 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:33518") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:56300->172.17.0.9:33518, err= 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:32832") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:55908->172.17.0.9:32832, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsListRSubdir#01 fstests.go:399: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsPutFiles/FsListLevel2 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:18060") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:40494->172.17.0.9:18060, err= 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:64659") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:39176->172.17.0.9:64659, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsListRLevel2 fstests.go:399: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsPutFiles/FsListFile1 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:22764") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:38704->172.17.0.9:22764, err= 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:65475") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:44656->172.17.0.9:65475, err= 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:19990") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:54370->172.17.0.9:19990, err= 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:38825") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:34268->172.17.0.9:38825, err= 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:21294") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:51464->172.17.0.9:21294, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsNewObject === RUN TestIntegration/FsMkdir/FsPutFiles/FsNewObjectCaseInsensitive fstests.go:1121: Not Case Insensitive === RUN TestIntegration/FsMkdir/FsPutFiles/FsListFile1and2 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:38321") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:37486->172.17.0.9:38321, err= 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:20396") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:39186->172.17.0.9:20396, err= 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:41903") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:44244->172.17.0.9:41903, err= 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:16947") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:59982->172.17.0.9:16947, err= 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:56232") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:46990->172.17.0.9:56232, 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 2026/01/05 04:54:48 DEBUG : Creating backend with remote "TestFTPProftpd:rclone-test-ceniciq3gecu/hello? sausage/êé" 2026/01/05 04:54:48 DEBUG : Setting type="ftp" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_TYPE 2026/01/05 04:54:48 DEBUG : Setting host="172.17.0.9" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2026/01/05 04:54:48 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2026/01/05 04:54:48 DEBUG : Setting pass="RwYKDb3TQOm5-G8-WZGB92gm-EV0vfwkP_TUaWF_M7003A" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2026/01/05 04:54:48 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2026/01/05 04:54:48 DEBUG : TestFTPProftpd: detected overridden config - adding "{8tlHY}" suffix to name 2026/01/05 04:54:48 DEBUG : Setting host="172.17.0.9" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2026/01/05 04:54:48 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2026/01/05 04:54:48 DEBUG : Setting pass="RwYKDb3TQOm5-G8-WZGB92gm-EV0vfwkP_TUaWF_M7003A" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2026/01/05 04:54:48 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: Connecting to FTP server 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: dial("tcp","172.17.0.9:21") 2026/01/05 04:54:48 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: > dial: conn=172.17.0.1:57990->172.17.0.9:21, err= 2026/01/05 04:54:49 DEBUG : fs cache: renaming cache item "TestFTPProftpd:rclone-test-ceniciq3gecu/hello? sausage/êé" to be canonical "TestFTPProftpd{8tlHY}:rclone-test-ceniciq3gecu/hello? sausage/êé" 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: dial("tcp","172.17.0.9:42635") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: > dial: conn=172.17.0.1:33898->172.17.0.9:42635, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: dial("tcp","172.17.0.9:22180") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: > dial: conn=172.17.0.1:46710->172.17.0.9:22180, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: Connecting to FTP server 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: dial("tcp","172.17.0.9:21") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: > dial: conn=172.17.0.1:57994->172.17.0.9:21, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: dial("tcp","172.17.0.9:10423") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: > dial: conn=172.17.0.1:42084->172.17.0.9:10423, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: dial("tcp","172.17.0.9:9595") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: > dial: conn=172.17.0.1:50852->172.17.0.9:9595, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: dial("tcp","172.17.0.9:4822") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: > dial: conn=172.17.0.1:59776->172.17.0.9:4822, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: dial("tcp","172.17.0.9:49142") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: > dial: conn=172.17.0.1:50762->172.17.0.9:49142, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: dial("tcp","172.17.0.9:47815") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: > dial: conn=172.17.0.1:45226->172.17.0.9:47815, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: dial("tcp","172.17.0.9:38608") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: > dial: conn=172.17.0.1:54268->172.17.0.9:38608, err= 2026/01/05 04:54:49 DEBUG : Waiting for deletions to finish 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: dial("tcp","172.17.0.9:23613") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: > dial: conn=172.17.0.1:36574->172.17.0.9:23613, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: dial("tcp","172.17.0.9:21465") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: > dial: conn=172.17.0.1:36932->172.17.0.9:21465, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: dial("tcp","172.17.0.9:3080") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: > dial: conn=172.17.0.1:57578->172.17.0.9:3080, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: dial("tcp","172.17.0.9:35567") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: > dial: conn=172.17.0.1:36502->172.17.0.9:35567, err= 2026/01/05 04:54:49 INFO : a/b/c/d/e.txt: Deleted 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: dial("tcp","172.17.0.9:61216") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: > dial: conn=172.17.0.1:53728->172.17.0.9:61216, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: dial("tcp","172.17.0.9:30671") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: > dial: conn=172.17.0.1:60576->172.17.0.9:30671, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: dial("tcp","172.17.0.9:42051") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: > dial: conn=172.17.0.1:35864->172.17.0.9:42051, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: dial("tcp","172.17.0.9:21911") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé: > dial: conn=172.17.0.1:42316->172.17.0.9:21911, err= 2026/01/05 04:54:49 DEBUG : removing 1 level 4 directories 2026/01/05 04:54:49 INFO : a/b/c/d: Removing directory 2026/01/05 04:54:49 DEBUG : removing 1 level 3 directories 2026/01/05 04:54:49 INFO : a/b/c: Removing directory 2026/01/05 04:54:49 DEBUG : removing 1 level 2 directories 2026/01/05 04:54:49 INFO : a/b: Removing directory 2026/01/05 04:54:49 DEBUG : removing 1 level 1 directories 2026/01/05 04:54:49 INFO : a: Removing directory === RUN TestIntegration/FsMkdir/FsPutFiles/FsCopy fstests.go:1254: FS has no Copier interface === RUN TestIntegration/FsMkdir/FsPutFiles/FsMove 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:64413") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:59608->172.17.0.9:64413, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:58336") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:51580->172.17.0.9:58336, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:2725") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:37820->172.17.0.9:2725, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:19625") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:57374->172.17.0.9:19625, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:62323") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:46346->172.17.0.9:62323, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:60513") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:52586->172.17.0.9:60513, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: Connecting to FTP server 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:21") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:58008->172.17.0.9:21, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:9911") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:51458->172.17.0.9:9911, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:12910") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:45290->172.17.0.9:12910, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:61644") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:41392->172.17.0.9:61644, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:39797") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:49426->172.17.0.9:39797, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:8009") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:43080->172.17.0.9:8009, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:43729") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:36808->172.17.0.9:43729, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:64947") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:54224->172.17.0.9:64947, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:30858") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:45364->172.17.0.9:30858, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:54192") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:55050->172.17.0.9:54192, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:36148") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:39546->172.17.0.9:36148, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:5283") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:33998->172.17.0.9:5283, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:3667") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:38738->172.17.0.9:3667, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:15359") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:13339") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:44840->172.17.0.9:15359, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:50348->172.17.0.9:13339, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:15400") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:40640->172.17.0.9:15400, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:29575") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:45984->172.17.0.9:29575, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:38480") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:40620->172.17.0.9:38480, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsMove/Metadata fstests.go:1398: Skipping test as can't write metadata === RUN TestIntegration/FsMkdir/FsPutFiles/FsDirMove 2026/01/05 04:54:49 DEBUG : Creating backend with remote "TestFTPProftpd:rclone-test-kiculul6duma" 2026/01/05 04:54:49 DEBUG : Setting type="ftp" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_TYPE 2026/01/05 04:54:49 DEBUG : Setting host="172.17.0.9" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2026/01/05 04:54:49 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2026/01/05 04:54:49 DEBUG : Setting pass="RwYKDb3TQOm5-G8-WZGB92gm-EV0vfwkP_TUaWF_M7003A" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2026/01/05 04:54:49 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2026/01/05 04:54:49 DEBUG : TestFTPProftpd: detected overridden config - adding "{8tlHY}" suffix to name 2026/01/05 04:54:49 DEBUG : Setting host="172.17.0.9" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2026/01/05 04:54:49 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2026/01/05 04:54:49 DEBUG : Setting pass="RwYKDb3TQOm5-G8-WZGB92gm-EV0vfwkP_TUaWF_M7003A" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2026/01/05 04:54:49 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-kiculul6duma: Connecting to FTP server 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-kiculul6duma: dial("tcp","172.17.0.9:21") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-kiculul6duma: > dial: conn=172.17.0.1:58012->172.17.0.9:21, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:19556") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:41170->172.17.0.9:19556, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-kiculul6duma: dial("tcp","172.17.0.9:42490") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-kiculul6duma: > dial: conn=172.17.0.1:39570->172.17.0.9:42490, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-kiculul6duma: dial("tcp","172.17.0.9:55963") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-kiculul6duma: > dial: conn=172.17.0.1:57114->172.17.0.9:55963, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-kiculul6duma: dial("tcp","172.17.0.9:19869") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-kiculul6duma: > dial: conn=172.17.0.1:45378->172.17.0.9:19869, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-kiculul6duma: dial("tcp","172.17.0.9:4140") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-kiculul6duma: > dial: conn=172.17.0.1:33008->172.17.0.9:4140, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-kiculul6duma: dial("tcp","172.17.0.9:62477") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-kiculul6duma: > dial: conn=172.17.0.1:53780->172.17.0.9:62477, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-kiculul6duma: dial("tcp","172.17.0.9:50489") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-kiculul6duma: > dial: conn=172.17.0.1:34236->172.17.0.9:50489, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-kiculul6duma: dial("tcp","172.17.0.9:2110") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-kiculul6duma: > dial: conn=172.17.0.1:44802->172.17.0.9:2110, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:35344") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:48508->172.17.0.9:35344, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:43722") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:37888->172.17.0.9:43722, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:51507") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:44364->172.17.0.9:51507, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:61574") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:45480->172.17.0.9:61574, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:6464") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:39466->172.17.0.9:6464, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-kiculul6duma: dial("tcp","172.17.0.9:42464") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-kiculul6duma: > dial: conn=172.17.0.1:58328->172.17.0.9:42464, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-kiculul6duma: dial("tcp","172.17.0.9:61274") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-kiculul6duma: > dial: conn=172.17.0.1:56366->172.17.0.9:61274, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-kiculul6duma: dial("tcp","172.17.0.9:65036") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-kiculul6duma: > dial: conn=172.17.0.1:54982->172.17.0.9:65036, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-kiculul6duma: dial("tcp","172.17.0.9:34596") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-kiculul6duma: > dial: conn=172.17.0.1:55036->172.17.0.9:34596, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-kiculul6duma: Purge dir "new_name" 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-kiculul6duma: 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 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:55599") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:46372->172.17.0.9:55599, err= === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectOpenSeek 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:44079") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:51304->172.17.0.9:44079, err= === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectOpenRange 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:58763") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:37740->172.17.0.9:58763, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:2642") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:47050->172.17.0.9:2642, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:7322") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:58796->172.17.0.9:7322, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:4032") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:59636->172.17.0.9:4032, err= === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectPartialRead 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:5589") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:39202->172.17.0.9:5589, err= === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectUpdate 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:24383") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:35162->172.17.0.9:24383, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:3973") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:36350->172.17.0.9:3973, err= === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectStorable === RUN TestIntegration/FsMkdir/FsPutFiles/FsIsFile 2026/01/05 04:54:49 DEBUG : Creating backend with remote "TestFTPProftpd:rclone-test-ceniciq3gecu/hello? sausage/êé/Hello, 世界/ \" ' @ < > & ? + ≠/z.txt" 2026/01/05 04:54:49 DEBUG : Setting type="ftp" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_TYPE 2026/01/05 04:54:49 DEBUG : Setting host="172.17.0.9" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2026/01/05 04:54:49 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2026/01/05 04:54:49 DEBUG : Setting pass="RwYKDb3TQOm5-G8-WZGB92gm-EV0vfwkP_TUaWF_M7003A" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2026/01/05 04:54:49 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2026/01/05 04:54:49 DEBUG : TestFTPProftpd: detected overridden config - adding "{8tlHY}" suffix to name 2026/01/05 04:54:49 DEBUG : Setting host="172.17.0.9" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2026/01/05 04:54:49 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2026/01/05 04:54:49 DEBUG : Setting pass="RwYKDb3TQOm5-G8-WZGB92gm-EV0vfwkP_TUaWF_M7003A" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2026/01/05 04:54:49 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: Connecting to FTP server 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: dial("tcp","172.17.0.9:21") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: > dial: conn=172.17.0.1:58018->172.17.0.9:21, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsIsFile/FsRoot 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: dial("tcp","172.17.0.9:19073") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: > dial: conn=172.17.0.1:54238->172.17.0.9:19073, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsIsFileNotFound 2026/01/05 04:54:49 DEBUG : Creating backend with remote "TestFTPProftpd:rclone-test-ceniciq3gecu/not found.txt" 2026/01/05 04:54:49 DEBUG : Setting type="ftp" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_TYPE 2026/01/05 04:54:49 DEBUG : Setting host="172.17.0.9" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2026/01/05 04:54:49 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2026/01/05 04:54:49 DEBUG : Setting pass="RwYKDb3TQOm5-G8-WZGB92gm-EV0vfwkP_TUaWF_M7003A" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2026/01/05 04:54:49 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2026/01/05 04:54:49 DEBUG : TestFTPProftpd: detected overridden config - adding "{8tlHY}" suffix to name 2026/01/05 04:54:49 DEBUG : Setting host="172.17.0.9" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2026/01/05 04:54:49 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2026/01/05 04:54:49 DEBUG : Setting pass="RwYKDb3TQOm5-G8-WZGB92gm-EV0vfwkP_TUaWF_M7003A" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2026/01/05 04:54:49 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/not found.txt: Connecting to FTP server 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/not found.txt: dial("tcp","172.17.0.9:21") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/not found.txt: > dial: conn=172.17.0.1:58022->172.17.0.9:21, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/not found.txt: dial("tcp","172.17.0.9:16626") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/not found.txt: > dial: conn=172.17.0.1:38746->172.17.0.9:16626, err= 2026/01/05 04:54:49 ERROR : error listing: directory not found === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot fstests.go:1911: Opening root remote "TestFTPProftpd:" path "rclone-test-ceniciq3gecu" from "TestFTPProftpd:rclone-test-ceniciq3gecu" 2026/01/05 04:54:49 DEBUG : Creating backend with remote "TestFTPProftpd:" 2026/01/05 04:54:49 DEBUG : Setting type="ftp" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_TYPE 2026/01/05 04:54:49 DEBUG : Setting host="172.17.0.9" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2026/01/05 04:54:49 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2026/01/05 04:54:49 DEBUG : Setting pass="RwYKDb3TQOm5-G8-WZGB92gm-EV0vfwkP_TUaWF_M7003A" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2026/01/05 04:54:49 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2026/01/05 04:54:49 DEBUG : TestFTPProftpd: detected overridden config - adding "{8tlHY}" suffix to name 2026/01/05 04:54:49 DEBUG : Setting host="172.17.0.9" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2026/01/05 04:54:49 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2026/01/05 04:54:49 DEBUG : Setting pass="RwYKDb3TQOm5-G8-WZGB92gm-EV0vfwkP_TUaWF_M7003A" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2026/01/05 04:54:49 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: Connecting to FTP server 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: dial("tcp","172.17.0.9:21") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: > dial: conn=172.17.0.1:58026->172.17.0.9:21, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot/List 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: dial("tcp","172.17.0.9:25255") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: > dial: conn=172.17.0.1:60178->172.17.0.9:25255, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: dial("tcp","172.17.0.9:59371") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: > dial: conn=172.17.0.1:35842->172.17.0.9:59371, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: dial("tcp","172.17.0.9:28047") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: > dial: conn=172.17.0.1:53122->172.17.0.9:28047, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: dial("tcp","172.17.0.9:65294") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: > dial: conn=172.17.0.1:46328->172.17.0.9:65294, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: dial("tcp","172.17.0.9:20832") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: > dial: conn=172.17.0.1:44812->172.17.0.9:20832, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot/ListEntries 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: dial("tcp","172.17.0.9:2318") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: > dial: conn=172.17.0.1:45842->172.17.0.9:2318, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot/ListR fstests.go:1945: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot/Put 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: dial("tcp","172.17.0.9:48459") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: > dial: conn=172.17.0.1:40758->172.17.0.9:48459, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: dial("tcp","172.17.0.9:3291") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: > dial: conn=172.17.0.1:53446->172.17.0.9:3291, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: dial("tcp","172.17.0.9:37085") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: > dial: conn=172.17.0.1:60792->172.17.0.9:37085, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: dial("tcp","172.17.0.9:30941") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: > dial: conn=172.17.0.1:34048->172.17.0.9:30941, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: dial("tcp","172.17.0.9:9798") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: > dial: conn=172.17.0.1:47706->172.17.0.9:9798, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: dial("tcp","172.17.0.9:6288") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: > dial: conn=172.17.0.1:45832->172.17.0.9:6288, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot/Put/Remove 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: dial("tcp","172.17.0.9:29469") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: > dial: conn=172.17.0.1:47214->172.17.0.9:29469, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: dial("tcp","172.17.0.9:14552") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: > dial: conn=172.17.0.1:45206->172.17.0.9:14552, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: dial("tcp","172.17.0.9:2338") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: > dial: conn=172.17.0.1:55908->172.17.0.9:2338, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: dial("tcp","172.17.0.9:58810") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: > dial: conn=172.17.0.1:37560->172.17.0.9:58810, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: dial("tcp","172.17.0.9:53626") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21: > dial: conn=172.17.0.1:41914->172.17.0.9:53626, 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 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:6972") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:41714->172.17.0.9:6972, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:24555") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:49032->172.17.0.9:24555, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:62866") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:42422->172.17.0.9:62866, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:62184") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:58116->172.17.0.9:62184, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:40947") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:57384->172.17.0.9:40947, 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 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:40382") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:54894->172.17.0.9:40382, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsPutStream/100 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:24243") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:47354->172.17.0.9:24243, err= === RUN TestIntegration/FsMkdir/FsPutFiles/Internal === RUN TestIntegration/FsMkdir/FsPutFiles/Internal/UploadTimeout 2026/01/05 04:54:49 DEBUG : Creating backend with remote "TestFTPProftpd,concurrency='0',shut_timeout='1s':rclone-test-ceniciq3gecu" 2026/01/05 04:54:49 DEBUG : Setting type="ftp" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_TYPE 2026/01/05 04:54:49 DEBUG : Setting host="172.17.0.9" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2026/01/05 04:54:49 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2026/01/05 04:54:49 DEBUG : Setting pass="RwYKDb3TQOm5-G8-WZGB92gm-EV0vfwkP_TUaWF_M7003A" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2026/01/05 04:54:49 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2026/01/05 04:54:49 DEBUG : TestFTPProftpd: detected overridden config - adding "{OOt-m}" suffix to name 2026/01/05 04:54:49 DEBUG : Setting host="172.17.0.9" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2026/01/05 04:54:49 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2026/01/05 04:54:49 DEBUG : Setting pass="RwYKDb3TQOm5-G8-WZGB92gm-EV0vfwkP_TUaWF_M7003A" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2026/01/05 04:54:49 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: Connecting to FTP server 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:21") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:58028->172.17.0.9:21, err= 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:22614") 2026/01/05 04:54:49 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:48780->172.17.0.9:22614, 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 2026/01/05 04:54:50 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:28755") 2026/01/05 04:54:50 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:49264->172.17.0.9:28755, err= === RUN TestIntegration/FsMkdir/FsUploadUnknownSize/FsUpdateUnknownSize 2026/01/05 04:54:50 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:36533") 2026/01/05 04:54:50 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:47500->172.17.0.9:36533, err= 2026/01/05 04:54:50 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:61852") 2026/01/05 04:54:50 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:53708->172.17.0.9:61852, err= === RUN TestIntegration/FsMkdir/FsRootCollapse 2026/01/05 04:54:50 DEBUG : Creating backend with remote "TestFTPProftpd:rclone-test-ceniciq3gecu/deeper/nonexisting/directory" 2026/01/05 04:54:50 DEBUG : Setting type="ftp" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_TYPE 2026/01/05 04:54:50 DEBUG : Setting host="172.17.0.9" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2026/01/05 04:54:50 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2026/01/05 04:54:50 DEBUG : Setting pass="RwYKDb3TQOm5-G8-WZGB92gm-EV0vfwkP_TUaWF_M7003A" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2026/01/05 04:54:50 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2026/01/05 04:54:50 DEBUG : TestFTPProftpd: detected overridden config - adding "{8tlHY}" suffix to name 2026/01/05 04:54:50 DEBUG : Setting host="172.17.0.9" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2026/01/05 04:54:50 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2026/01/05 04:54:50 DEBUG : Setting pass="RwYKDb3TQOm5-G8-WZGB92gm-EV0vfwkP_TUaWF_M7003A" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2026/01/05 04:54:50 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2026/01/05 04:54:50 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/deeper/nonexisting/directory: Connecting to FTP server 2026/01/05 04:54:50 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/deeper/nonexisting/directory: dial("tcp","172.17.0.9:21") 2026/01/05 04:54:50 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu/deeper/nonexisting/directory: > dial: conn=172.17.0.1:58040->172.17.0.9: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 2026/01/05 04:54:50 DEBUG : Waiting for deletions to finish 2026/01/05 04:54:50 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:30627") 2026/01/05 04:54:50 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:52386->172.17.0.9:30627, err= 2026/01/05 04:54:50 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:17045") 2026/01/05 04:54:50 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:49010->172.17.0.9:17045, err= 2026/01/05 04:54:50 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:54455") 2026/01/05 04:54:50 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:58604->172.17.0.9:54455, err= 2026/01/05 04:54:50 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:65123") 2026/01/05 04:54:50 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:54954->172.17.0.9:65123, err= 2026/01/05 04:54:50 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:14699") 2026/01/05 04:54:50 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:35912->172.17.0.9:14699, err= 2026/01/05 04:54:50 INFO : hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: Deleted 2026/01/05 04:54:50 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:13264") 2026/01/05 04:54:50 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:35638->172.17.0.9:13264, err= 2026/01/05 04:54:50 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:23234") 2026/01/05 04:54:50 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:47458->172.17.0.9:23234, err= 2026/01/05 04:54:50 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:7743") 2026/01/05 04:54:50 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:60022->172.17.0.9:7743, err= 2026/01/05 04:54:50 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:23104") 2026/01/05 04:54:50 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:46964->172.17.0.9:23104, err= 2026/01/05 04:54:50 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:64001") 2026/01/05 04:54:50 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:33866->172.17.0.9:64001, err= 2026/01/05 04:54:50 DEBUG : removing 1 level 4 directories 2026/01/05 04:54:50 INFO : hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠: Removing directory 2026/01/05 04:54:50 DEBUG : removing 1 level 3 directories 2026/01/05 04:54:50 INFO : hello? sausage/êé/Hello, 世界: Removing directory 2026/01/05 04:54:50 DEBUG : removing 1 level 2 directories 2026/01/05 04:54:50 INFO : hello? sausage/êé: Removing directory 2026/01/05 04:54:50 DEBUG : removing 1 level 1 directories 2026/01/05 04:54:50 INFO : hello? sausage: Removing directory 2026/01/05 04:54:50 DEBUG : removing 1 level 0 directories 2026/01/05 04:54:50 INFO : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: Removing directory 2026/01/05 04:54:50 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:6066") 2026/01/05 04:54:50 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:57102->172.17.0.9:6066, err= 2026/01/05 04:54:50 ERROR : error listing: directory not found 2026/01/05 04:54:50 DEBUG : Waiting for deletions to finish 2026/01/05 04:54:50 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:29351") 2026/01/05 04:54:50 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:60666->172.17.0.9:29351, err= 2026/01/05 04:54:50 ERROR : error listing: directory not found 2026/01/05 04:54:50 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: dial("tcp","172.17.0.9:9445") 2026/01/05 04:54:50 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: > dial: conn=172.17.0.1:48670->172.17.0.9:9445, err= 2026/01/05 04:54:50 ERROR : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: Failed to list "": directory not found 2026/01/05 04:54:50 DEBUG : removing 1 level 0 directories 2026/01/05 04:54:50 INFO : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: Removing directory 2026/01/05 04:54:50 ERROR : Failed to rmdir: directory not found === RUN TestIntegration/FsShutdown 2026/01/05 04:54:50 DEBUG : ftp://172.17.0.9:21/rclone-test-ceniciq3gecu: closing 2 unused connections 2026/01/05 04:54:50 NOTICE: TestFTPProftpd: Stopping server --- PASS: TestIntegration (4.09s) --- 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.78s) --- 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.29s) --- PASS: TestIntegration/FsMkdir/FsEncoding/control_chars (0.02s) --- PASS: TestIntegration/FsMkdir/FsEncoding/dot (0.02s) --- PASS: TestIntegration/FsMkdir/FsEncoding/dot_dot (0.02s) --- PASS: TestIntegration/FsMkdir/FsEncoding/punctuation (0.02s) --- PASS: TestIntegration/FsMkdir/FsEncoding/leading_space (0.02s) --- PASS: TestIntegration/FsMkdir/FsEncoding/leading_tilde (0.02s) --- PASS: TestIntegration/FsMkdir/FsEncoding/leading_CR (0.02s) --- PASS: TestIntegration/FsMkdir/FsEncoding/leading_LF (0.02s) --- 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.02s) --- PASS: TestIntegration/FsMkdir/FsEncoding/trailing_VT (0.02s) --- PASS: TestIntegration/FsMkdir/FsEncoding/trailing_dot (0.02s) --- PASS: TestIntegration/FsMkdir/FsEncoding/invalid_UTF-8 (0.02s) --- PASS: TestIntegration/FsMkdir/FsEncoding/URL_encoding (0.02s) --- 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.37s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListDirFile2 (0.01s) --- 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.02s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsNewObject (0.00s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FsNewObjectCaseInsensitive (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListFile1and2 (0.02s) --- 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.08s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FsCopy (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsMove (0.08s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FsMove/Metadata (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsDirMove (0.08s) --- 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.02s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FromRoot/ListEntries (0.00s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FromRoot/ListR (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FromRoot/Put (0.03s) --- 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.02s) --- 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.01s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/Internal (0.79s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/Internal/UploadTimeout (0.79s) --- 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.01s) --- 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 4.101s "go test -v -timeout 1h0m0s -remote TestFTPProftpd: -verbose" - Finished OK in 4.809320368s (try 1/5)