"go test -v -timeout 1h0m0s -remote TestFTPProftpd: -verbose" - Starting (try 1/5) === RUN TestIntegration fstests.go:457: Using remote "TestFTPProftpd:" 2026/07/30 01:42:13 NOTICE: TestFTPProftpd: Starting server 2026/07/30 01:42:14 NOTICE: TestFTPProftpd: Attempting to connect to "172.17.0.4:21" try 1/100 2026/07/30 01:42:14 DEBUG : TestFTPProftpd: Read 1, error: 2026/07/30 01:42:14 NOTICE: TestFTPProftpd: Started server and connected to "172.17.0.4:21" 2026/07/30 01:42:14 DEBUG : Creating backend with remote "TestFTPProftpd:rclone-test-sunekad6yona" 2026/07/30 01:42:14 DEBUG : Using config file from "/home/rclone/.rclone.conf" 2026/07/30 01:42:14 DEBUG : Setting type="ftp" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_TYPE 2026/07/30 01:42:14 DEBUG : Setting host="172.17.0.4" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2026/07/30 01:42:14 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2026/07/30 01:42:14 DEBUG : Setting pass="HPeh3lXIsEIb5jUKHX-H_298TzHeh1VQRQuMRj0oUaokTw" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2026/07/30 01:42:14 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2026/07/30 01:42:14 DEBUG : TestFTPProftpd: detected overridden config - adding "{v9bBG}" suffix to name 2026/07/30 01:42:14 DEBUG : Setting host="172.17.0.4" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2026/07/30 01:42:14 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2026/07/30 01:42:14 DEBUG : Setting pass="HPeh3lXIsEIb5jUKHX-H_298TzHeh1VQRQuMRj0oUaokTw" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2026/07/30 01:42:14 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: Connecting to FTP server 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:21") 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:58616->172.17.0.4:21, err= 2026/07/30 01:42:14 DEBUG : Setting type="ftp" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_TYPE === RUN TestIntegration/FsCheckWrap fstests.go:498: Not a wrapping Fs === RUN TestIntegration/FsCommand fstests.go:526: No commands in this remote === RUN TestIntegration/FsRmdirNotFound 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:53710") 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:58470->172.17.0.4:53710, err= === RUN TestIntegration/FsString === RUN TestIntegration/FsName === RUN TestIntegration/FsRoot === RUN TestIntegration/FsRmdirEmpty === RUN TestIntegration/FsMkdir 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:7340") 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:52860->172.17.0.4:7340, err= === RUN TestIntegration/FsMkdir/FsMkdirRmdirSubdir 2026/07/30 01:42:14 INFO : dir/subdir: Making directory 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:18540") 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:40186->172.17.0.4:18540, err= 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:20378") 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:56098->172.17.0.4:20378, err= 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:31521") 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:54200->172.17.0.4:31521, err= 2026/07/30 01:42:14 INFO : dir/subdir: Removing directory 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:46490") 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:50688->172.17.0.4:46490, err= 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:49730") 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:57960->172.17.0.4:49730, err= 2026/07/30 01:42:14 INFO : dir: Removing directory 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:1142") 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:36472->172.17.0.4:1142, err= === RUN TestIntegration/FsMkdir/FsListEmpty 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:14121") 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:48236->172.17.0.4:14121, err= === RUN TestIntegration/FsMkdir/FsListDirEmpty 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:5560") 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:60150->172.17.0.4:5560, err= === RUN TestIntegration/FsMkdir/FsListRDirEmpty fstests.go:418: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsListDirNotFound 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:22611") 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:42678->172.17.0.4:22611, err= 2026/07/30 01:42:14 ERROR : does not exist: error listing: directory not found === RUN TestIntegration/FsMkdir/FsListRDirNotFound fstests.go:418: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsEncoding 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:34865") 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:36140->172.17.0.4:34865, err= === RUN TestIntegration/FsMkdir/FsEncoding/control_chars fstests.go:727: testing "␀␁␂␃␄␅␆␇␈␉␊␋␌␍␎␏␐␑␒␓␔␕␖␗␘␙␚␛␜␝␞␟␡" 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:16825") 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:35746->172.17.0.4:16825, err= 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:62253") 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:46842->172.17.0.4:62253, err= 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:25506") 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:37234->172.17.0.4:25506, err= 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:37962") 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:34302->172.17.0.4:37962, err= === RUN TestIntegration/FsMkdir/FsEncoding/dot fstests.go:727: testing "." 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:33228") 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:36140->172.17.0.4:33228, err= 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:9539") 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:58808->172.17.0.4:9539, err= 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:32635") 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:42584->172.17.0.4:32635, err= 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:9156") 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:40296->172.17.0.4:9156, err= === RUN TestIntegration/FsMkdir/FsEncoding/dot_dot fstests.go:727: testing ".." 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:43717") 2026/07/30 01:42:14 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:40336->172.17.0.4:43717, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:51075") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:42494->172.17.0.4:51075, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:59149") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:41720->172.17.0.4:59149, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:47005") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:53914->172.17.0.4:47005, err= === RUN TestIntegration/FsMkdir/FsEncoding/punctuation fstests.go:727: testing "!\"#$%&'()*+,-./:;<=>?@[\\]^_`{|}~" 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:41233") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:59872->172.17.0.4:41233, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:13765") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:47400->172.17.0.4:13765, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:12290") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:49098->172.17.0.4:12290, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:57453") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:45170->172.17.0.4:57453, err= === RUN TestIntegration/FsMkdir/FsEncoding/leading_space fstests.go:727: testing " leading space" 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:3078") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:59906->172.17.0.4:3078, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:39556") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:50318->172.17.0.4:39556, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:2948") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:53184->172.17.0.4:2948, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:55764") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:33728->172.17.0.4:55764, err= === RUN TestIntegration/FsMkdir/FsEncoding/leading_tilde fstests.go:727: testing "~leading tilde" 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:45873") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:56740->172.17.0.4:45873, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:20464") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:57878->172.17.0.4:20464, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:10608") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:42698->172.17.0.4:10608, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:11859") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:49576->172.17.0.4:11859, err= === RUN TestIntegration/FsMkdir/FsEncoding/leading_CR fstests.go:727: testing "␍leading CR" 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:1420") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:53412->172.17.0.4:1420, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:59314") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:40036->172.17.0.4:59314, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:11977") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:38848->172.17.0.4:11977, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:14517") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:39972->172.17.0.4:14517, err= === RUN TestIntegration/FsMkdir/FsEncoding/leading_LF fstests.go:727: testing "␊leading LF" 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:63851") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:49794->172.17.0.4:63851, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:33564") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:49510->172.17.0.4:33564, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:48359") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:43368->172.17.0.4:48359, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:15141") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:57740->172.17.0.4:15141, err= === RUN TestIntegration/FsMkdir/FsEncoding/leading_HT fstests.go:727: testing "␉leading HT" 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:30283") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:51812->172.17.0.4:30283, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:8331") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:48584->172.17.0.4:8331, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:52080") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:38324->172.17.0.4:52080, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:62488") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:34028->172.17.0.4:62488, err= === RUN TestIntegration/FsMkdir/FsEncoding/leading_VT fstests.go:727: testing "␋leading VT" 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:16846") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:60888->172.17.0.4:16846, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:19181") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:59416->172.17.0.4:19181, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:6109") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:55606->172.17.0.4:6109, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:59540") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:51242->172.17.0.4:59540, err= === RUN TestIntegration/FsMkdir/FsEncoding/leading_dot fstests.go:727: testing ".leading dot" 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:4721") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:48754->172.17.0.4:4721, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:64235") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:59236->172.17.0.4:64235, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:41011") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:34274->172.17.0.4:41011, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:44931") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:59532->172.17.0.4:44931, err= === RUN TestIntegration/FsMkdir/FsEncoding/trailing_space fstests.go:727: testing "trailing space " 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:12465") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:59094->172.17.0.4:12465, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:52278") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:38132->172.17.0.4:52278, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:36850") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:59768->172.17.0.4:36850, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:14520") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:47074->172.17.0.4:14520, err= === RUN TestIntegration/FsMkdir/FsEncoding/trailing_CR fstests.go:727: testing "trailing CR␍" 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:26299") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:48430->172.17.0.4:26299, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:38774") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:38458->172.17.0.4:38774, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:4750") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:46894->172.17.0.4:4750, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:6637") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:58318->172.17.0.4:6637, err= === RUN TestIntegration/FsMkdir/FsEncoding/trailing_LF fstests.go:727: testing "trailing LF␊" 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:58215") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:42134->172.17.0.4:58215, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:14334") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:51516->172.17.0.4:14334, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:17473") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:56854->172.17.0.4:17473, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:58612") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:49510->172.17.0.4:58612, err= === RUN TestIntegration/FsMkdir/FsEncoding/trailing_HT fstests.go:727: testing "trailing HT␉" 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:8114") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:36056->172.17.0.4:8114, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:28426") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:42742->172.17.0.4:28426, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:7595") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:42944->172.17.0.4:7595, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:6431") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:33246->172.17.0.4:6431, err= === RUN TestIntegration/FsMkdir/FsEncoding/trailing_VT fstests.go:727: testing "trailing VT␋" 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:60967") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:40290->172.17.0.4:60967, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:54930") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:47102->172.17.0.4:54930, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:20548") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:44654->172.17.0.4:20548, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:25715") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:43210->172.17.0.4:25715, err= === RUN TestIntegration/FsMkdir/FsEncoding/trailing_dot fstests.go:727: testing "trailing dot." 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:62237") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:53876->172.17.0.4:62237, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:7094") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:46046->172.17.0.4:7094, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:22669") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:44128->172.17.0.4:22669, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:13549") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:35976->172.17.0.4:13549, err= === RUN TestIntegration/FsMkdir/FsEncoding/invalid_UTF-8 fstests.go:727: testing "invalid utf-8\xfe" 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:25251") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:39378->172.17.0.4:25251, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:27755") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:36694->172.17.0.4:27755, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:7554") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:37638->172.17.0.4:7554, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:28949") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:48944->172.17.0.4:28949, err= === RUN TestIntegration/FsMkdir/FsEncoding/URL_encoding fstests.go:727: testing "test%46.txt" 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:26455") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:51344->172.17.0.4:26455, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:47542") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:42976->172.17.0.4:47542, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:8345") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:36352->172.17.0.4:8345, err= 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:37896") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:47112->172.17.0.4:37896, err= === RUN TestIntegration/FsMkdir/FsNewObjectNotFound === RUN TestIntegration/FsMkdir/FsPutError 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:34285") 2026/07/30 01:42:15 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:43230->172.17.0.4:34285, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: Connecting to FTP server 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:21") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:58620->172.17.0.4:21, err= 2026/07/30 01:42:16 DEBUG : hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: Removed after failed upload: 1 error occurred: * potato === RUN TestIntegration/FsMkdir/FsPutZeroLength 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:38251") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:35694->172.17.0.4:38251, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:29496") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:39622->172.17.0.4:29496, err= === RUN TestIntegration/FsMkdir/FsOpenWriterAt fstests.go:806: FS has no OpenWriterAt interface === RUN TestIntegration/FsMkdir/FsOpenChunkWriter fstests.go:839: FS has no OpenChunkWriter interface === RUN TestIntegration/FsMkdir/FsChangeNotify fstests.go:892: FS has no ChangeNotify interface === RUN TestIntegration/FsMkdir/FsPutFiles 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:38663") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:54656->172.17.0.4:38663, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:15398") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:33802->172.17.0.4:15398, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:19598") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:44690->172.17.0.4:19598, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsListDirFile2 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:9159") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:54990->172.17.0.4:9159, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:7453") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:34918->172.17.0.4:7453, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:15190") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:57330->172.17.0.4:15190, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:24024") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:52268->172.17.0.4:24024, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:3894") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:53784->172.17.0.4:3894, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsListRDirFile2 fstests.go:418: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsPutFiles/FsListR 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:42564") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:49192->172.17.0.4:42564, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:55515") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:39934->172.17.0.4:55515, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:34557") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:53428->172.17.0.4:34557, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:10394") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:37260->172.17.0.4:10394, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:3001") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:35946->172.17.0.4:3001, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsListRSubdir 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:40851") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:50230->172.17.0.4:40851, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:37656") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:38692->172.17.0.4:37656, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:18713") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:51080->172.17.0.4:18713, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:40418") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:58324->172.17.0.4:40418, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsListDirRoot 2026/07/30 01:42:16 DEBUG : Creating backend with remote "TestFTPProftpd:" 2026/07/30 01:42:16 DEBUG : Setting type="ftp" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_TYPE 2026/07/30 01:42:16 DEBUG : Setting host="172.17.0.4" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2026/07/30 01:42:16 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2026/07/30 01:42:16 DEBUG : Setting pass="HPeh3lXIsEIb5jUKHX-H_298TzHeh1VQRQuMRj0oUaokTw" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2026/07/30 01:42:16 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2026/07/30 01:42:16 DEBUG : TestFTPProftpd: detected overridden config - adding "{v9bBG}" suffix to name 2026/07/30 01:42:16 DEBUG : Setting host="172.17.0.4" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2026/07/30 01:42:16 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2026/07/30 01:42:16 DEBUG : Setting pass="HPeh3lXIsEIb5jUKHX-H_298TzHeh1VQRQuMRj0oUaokTw" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2026/07/30 01:42:16 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: Connecting to FTP server 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:21") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:58624->172.17.0.4:21, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:24990") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:49518->172.17.0.4:24990, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsListRDirRoot fstests.go:418: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsPutFiles/FsListSubdir 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:25898") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:60750->172.17.0.4:25898, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:12161") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:54014->172.17.0.4:12161, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsListRSubdir#01 fstests.go:418: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsPutFiles/FsListLevel2 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:39394") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:53348->172.17.0.4:39394, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:15755") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:46414->172.17.0.4:15755, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsListRLevel2 fstests.go:418: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsPutFiles/FsListFile1 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:12230") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:37744->172.17.0.4:12230, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:28049") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:54700->172.17.0.4:28049, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:59117") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:59960->172.17.0.4:59117, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:27343") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:41048->172.17.0.4:27343, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:14558") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:57874->172.17.0.4:14558, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsNewObject === RUN TestIntegration/FsMkdir/FsPutFiles/FsNewObjectCaseInsensitive fstests.go:1145: Not Case Insensitive === RUN TestIntegration/FsMkdir/FsPutFiles/FsListFile1and2 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:19896") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:50606->172.17.0.4:19896, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:24023") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:51708->172.17.0.4:24023, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:51528") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:57860->172.17.0.4:51528, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:57124") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:49798->172.17.0.4:57124, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:52495") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:49056->172.17.0.4:52495, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsNewObjectDir === RUN TestIntegration/FsMkdir/FsPutFiles/FsPurge fstests.go:1177: FS has no Purge interface === RUN TestIntegration/FsMkdir/FsPutFiles/FsPurgeRoot fstests.go:1214: FS has no Purge interface === RUN TestIntegration/FsMkdir/FsPutFiles/FsListRootedSubdir 2026/07/30 01:42:16 DEBUG : Creating backend with remote "TestFTPProftpd:rclone-test-sunekad6yona/hello? sausage/êé" 2026/07/30 01:42:16 DEBUG : Setting type="ftp" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_TYPE 2026/07/30 01:42:16 DEBUG : Setting host="172.17.0.4" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2026/07/30 01:42:16 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2026/07/30 01:42:16 DEBUG : Setting pass="HPeh3lXIsEIb5jUKHX-H_298TzHeh1VQRQuMRj0oUaokTw" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2026/07/30 01:42:16 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2026/07/30 01:42:16 DEBUG : TestFTPProftpd: detected overridden config - adding "{v9bBG}" suffix to name 2026/07/30 01:42:16 DEBUG : Setting host="172.17.0.4" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2026/07/30 01:42:16 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2026/07/30 01:42:16 DEBUG : Setting pass="HPeh3lXIsEIb5jUKHX-H_298TzHeh1VQRQuMRj0oUaokTw" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2026/07/30 01:42:16 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: Connecting to FTP server 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: dial("tcp","172.17.0.4:21") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: > dial: conn=172.17.0.1:58628->172.17.0.4:21, err= 2026/07/30 01:42:16 DEBUG : fs cache: renaming cache item "TestFTPProftpd:rclone-test-sunekad6yona/hello? sausage/êé" to be canonical "TestFTPProftpd{v9bBG}:rclone-test-sunekad6yona/hello? sausage/êé" 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: dial("tcp","172.17.0.4:25296") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: > dial: conn=172.17.0.1:57322->172.17.0.4:25296, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: dial("tcp","172.17.0.4:17370") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: > dial: conn=172.17.0.1:38596->172.17.0.4:17370, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: Connecting to FTP server 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: dial("tcp","172.17.0.4:21") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: > dial: conn=172.17.0.1:58630->172.17.0.4:21, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: dial("tcp","172.17.0.4:30743") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: > dial: conn=172.17.0.1:35646->172.17.0.4:30743, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: dial("tcp","172.17.0.4:51691") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: > dial: conn=172.17.0.1:41550->172.17.0.4:51691, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: dial("tcp","172.17.0.4:28014") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: > dial: conn=172.17.0.1:55032->172.17.0.4:28014, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: dial("tcp","172.17.0.4:32348") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: > dial: conn=172.17.0.1:46444->172.17.0.4:32348, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: dial("tcp","172.17.0.4:1570") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: > dial: conn=172.17.0.1:48232->172.17.0.4:1570, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: dial("tcp","172.17.0.4:46122") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: > dial: conn=172.17.0.1:35362->172.17.0.4:46122, err= 2026/07/30 01:42:16 DEBUG : Waiting for deletions to finish 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: dial("tcp","172.17.0.4:58415") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: > dial: conn=172.17.0.1:52974->172.17.0.4:58415, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: dial("tcp","172.17.0.4:2869") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: > dial: conn=172.17.0.1:36486->172.17.0.4:2869, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: dial("tcp","172.17.0.4:42888") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: > dial: conn=172.17.0.1:44272->172.17.0.4:42888, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: dial("tcp","172.17.0.4:29010") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: > dial: conn=172.17.0.1:37256->172.17.0.4:29010, err= 2026/07/30 01:42:16 INFO : a/b/c/d/e.txt: Deleted 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: dial("tcp","172.17.0.4:47485") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: > dial: conn=172.17.0.1:35568->172.17.0.4:47485, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: dial("tcp","172.17.0.4:11104") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: > dial: conn=172.17.0.1:44732->172.17.0.4:11104, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: dial("tcp","172.17.0.4:19344") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: > dial: conn=172.17.0.1:58780->172.17.0.4:19344, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: dial("tcp","172.17.0.4:54626") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé: > dial: conn=172.17.0.1:52652->172.17.0.4:54626, err= 2026/07/30 01:42:16 DEBUG : removing 1 level 4 directories 2026/07/30 01:42:16 INFO : a/b/c/d: Removing directory 2026/07/30 01:42:16 DEBUG : removing 1 level 3 directories 2026/07/30 01:42:16 INFO : a/b/c: Removing directory 2026/07/30 01:42:16 DEBUG : removing 1 level 2 directories 2026/07/30 01:42:16 INFO : a/b: Removing directory 2026/07/30 01:42:16 DEBUG : removing 1 level 1 directories 2026/07/30 01:42:16 INFO : a: Removing directory === RUN TestIntegration/FsMkdir/FsPutFiles/FsCopy fstests.go:1278: FS has no Copier interface === RUN TestIntegration/FsMkdir/FsPutFiles/FsMove 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:24657") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:39418->172.17.0.4:24657, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:6988") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:38866->172.17.0.4:6988, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:6558") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:45920->172.17.0.4:6558, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:32792") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:45686->172.17.0.4:32792, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:13418") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:43874->172.17.0.4:13418, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:20724") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:52702->172.17.0.4:20724, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: Connecting to FTP server 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:21") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:58642->172.17.0.4:21, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:55792") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:59700->172.17.0.4:55792, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:53722") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:46054->172.17.0.4:53722, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:16288") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:35758->172.17.0.4:16288, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:28554") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:56352->172.17.0.4:28554, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:62265") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:43426->172.17.0.4:62265, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:46420") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:58824->172.17.0.4:46420, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:45773") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:42760->172.17.0.4:45773, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:19722") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:43410->172.17.0.4:19722, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:49822") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:49066->172.17.0.4:49822, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:14889") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:51040->172.17.0.4:14889, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:7124") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:55004->172.17.0.4:7124, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:57621") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:37482->172.17.0.4:57621, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:13083") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:47750") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:51988->172.17.0.4:13083, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:34912->172.17.0.4:47750, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:14311") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:55588->172.17.0.4:14311, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:25139") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:33536->172.17.0.4:25139, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:22302") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:47436->172.17.0.4:22302, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsMove/Metadata fstests.go:1430: Skipping test as can't write metadata === RUN TestIntegration/FsMkdir/FsPutFiles/FsDirMove 2026/07/30 01:42:16 DEBUG : Creating backend with remote "TestFTPProftpd:rclone-test-luzanin2tiwe" 2026/07/30 01:42:16 DEBUG : Setting type="ftp" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_TYPE 2026/07/30 01:42:16 DEBUG : Setting host="172.17.0.4" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2026/07/30 01:42:16 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2026/07/30 01:42:16 DEBUG : Setting pass="HPeh3lXIsEIb5jUKHX-H_298TzHeh1VQRQuMRj0oUaokTw" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2026/07/30 01:42:16 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2026/07/30 01:42:16 DEBUG : TestFTPProftpd: detected overridden config - adding "{v9bBG}" suffix to name 2026/07/30 01:42:16 DEBUG : Setting host="172.17.0.4" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2026/07/30 01:42:16 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2026/07/30 01:42:16 DEBUG : Setting pass="HPeh3lXIsEIb5jUKHX-H_298TzHeh1VQRQuMRj0oUaokTw" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2026/07/30 01:42:16 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-luzanin2tiwe: Connecting to FTP server 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-luzanin2tiwe: dial("tcp","172.17.0.4:21") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-luzanin2tiwe: > dial: conn=172.17.0.1:58644->172.17.0.4:21, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:43756") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:49924->172.17.0.4:43756, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-luzanin2tiwe: dial("tcp","172.17.0.4:29650") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-luzanin2tiwe: > dial: conn=172.17.0.1:54506->172.17.0.4:29650, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-luzanin2tiwe: dial("tcp","172.17.0.4:4760") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-luzanin2tiwe: > dial: conn=172.17.0.1:40020->172.17.0.4:4760, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-luzanin2tiwe: dial("tcp","172.17.0.4:58279") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-luzanin2tiwe: > dial: conn=172.17.0.1:54218->172.17.0.4:58279, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-luzanin2tiwe: dial("tcp","172.17.0.4:47365") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-luzanin2tiwe: > dial: conn=172.17.0.1:36776->172.17.0.4:47365, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-luzanin2tiwe: dial("tcp","172.17.0.4:5820") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-luzanin2tiwe: > dial: conn=172.17.0.1:48982->172.17.0.4:5820, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-luzanin2tiwe: dial("tcp","172.17.0.4:44558") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-luzanin2tiwe: > dial: conn=172.17.0.1:43274->172.17.0.4:44558, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-luzanin2tiwe: dial("tcp","172.17.0.4:63386") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-luzanin2tiwe: > dial: conn=172.17.0.1:54532->172.17.0.4:63386, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:12547") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:37870->172.17.0.4:12547, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:65440") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:53186->172.17.0.4:65440, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:54164") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:33392->172.17.0.4:54164, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:64533") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:48934->172.17.0.4:64533, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:15563") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:39418->172.17.0.4:15563, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-luzanin2tiwe: dial("tcp","172.17.0.4:39000") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-luzanin2tiwe: > dial: conn=172.17.0.1:39780->172.17.0.4:39000, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-luzanin2tiwe: dial("tcp","172.17.0.4:7550") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-luzanin2tiwe: > dial: conn=172.17.0.1:33790->172.17.0.4:7550, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-luzanin2tiwe: dial("tcp","172.17.0.4:45430") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-luzanin2tiwe: > dial: conn=172.17.0.1:55720->172.17.0.4:45430, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-luzanin2tiwe: dial("tcp","172.17.0.4:63503") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-luzanin2tiwe: > dial: conn=172.17.0.1:43090->172.17.0.4:63503, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-luzanin2tiwe: Purge dir "new_name" 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-luzanin2tiwe: 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:1626: MimeType method not supported === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectMetadata fstests.go:1657: Metadata method not supported === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectSetMetadata fstests.go:1728: SetMetadata method not supported === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectSetModTime === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectSize === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectOpen 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:43082") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:36144->172.17.0.4:43082, err= === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectOpenSeek 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:21835") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:50282->172.17.0.4:21835, err= === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectOpenRange 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:47437") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:47264->172.17.0.4:47437, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:4119") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:49042->172.17.0.4:4119, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:29230") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:37614->172.17.0.4:29230, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:12066") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:41080->172.17.0.4:12066, err= === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectPartialRead 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:38392") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:32840->172.17.0.4:38392, err= === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectOpenFingerprint 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:18851") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:49796->172.17.0.4:18851, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:23273") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:45900->172.17.0.4:23273, err= === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectOpenFingerprint/full_read 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:36555") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:42548->172.17.0.4:36555, err= === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectOpenFingerprint/seek_read 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:65417") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:42132->172.17.0.4:65417, err= === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectOpenFingerprint/range_read 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:45977") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:57316->172.17.0.4:45977, err= === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectOpenFingerprint/range_read_to_end 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:12433") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:41698->172.17.0.4:12433, err= === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectOpenFingerprint/refresh 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:49592") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:55750->172.17.0.4:49592, err= === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectUpdate 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:14441") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:38754->172.17.0.4:14441, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:31306") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:47216->172.17.0.4:31306, err= === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectStorable === RUN TestIntegration/FsMkdir/FsPutFiles/FsIsFile 2026/07/30 01:42:16 DEBUG : Creating backend with remote "TestFTPProftpd:rclone-test-sunekad6yona/hello? sausage/êé/Hello, 世界/ \" ' @ < > & ? + ≠/z.txt" 2026/07/30 01:42:16 DEBUG : Setting type="ftp" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_TYPE 2026/07/30 01:42:16 DEBUG : Setting host="172.17.0.4" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2026/07/30 01:42:16 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2026/07/30 01:42:16 DEBUG : Setting pass="HPeh3lXIsEIb5jUKHX-H_298TzHeh1VQRQuMRj0oUaokTw" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2026/07/30 01:42:16 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2026/07/30 01:42:16 DEBUG : TestFTPProftpd: detected overridden config - adding "{v9bBG}" suffix to name 2026/07/30 01:42:16 DEBUG : Setting host="172.17.0.4" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2026/07/30 01:42:16 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2026/07/30 01:42:16 DEBUG : Setting pass="HPeh3lXIsEIb5jUKHX-H_298TzHeh1VQRQuMRj0oUaokTw" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2026/07/30 01:42:16 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: Connecting to FTP server 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: dial("tcp","172.17.0.4:21") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: > dial: conn=172.17.0.1:58648->172.17.0.4:21, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsIsFile/FsRoot 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: dial("tcp","172.17.0.4:49544") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: > dial: conn=172.17.0.1:39724->172.17.0.4:49544, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsIsFileNotFound 2026/07/30 01:42:16 DEBUG : Creating backend with remote "TestFTPProftpd:rclone-test-sunekad6yona/not found.txt" 2026/07/30 01:42:16 DEBUG : Setting type="ftp" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_TYPE 2026/07/30 01:42:16 DEBUG : Setting host="172.17.0.4" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2026/07/30 01:42:16 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2026/07/30 01:42:16 DEBUG : Setting pass="HPeh3lXIsEIb5jUKHX-H_298TzHeh1VQRQuMRj0oUaokTw" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2026/07/30 01:42:16 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2026/07/30 01:42:16 DEBUG : TestFTPProftpd: detected overridden config - adding "{v9bBG}" suffix to name 2026/07/30 01:42:16 DEBUG : Setting host="172.17.0.4" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2026/07/30 01:42:16 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2026/07/30 01:42:16 DEBUG : Setting pass="HPeh3lXIsEIb5jUKHX-H_298TzHeh1VQRQuMRj0oUaokTw" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2026/07/30 01:42:16 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/not found.txt: Connecting to FTP server 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/not found.txt: dial("tcp","172.17.0.4:21") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/not found.txt: > dial: conn=172.17.0.1:58660->172.17.0.4:21, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/not found.txt: dial("tcp","172.17.0.4:3236") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/not found.txt: > dial: conn=172.17.0.1:60548->172.17.0.4:3236, err= 2026/07/30 01:42:16 ERROR : error listing: directory not found === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot fstests.go:1987: Opening root remote "TestFTPProftpd:" path "rclone-test-sunekad6yona" from "TestFTPProftpd:rclone-test-sunekad6yona" 2026/07/30 01:42:16 DEBUG : Creating backend with remote "TestFTPProftpd:" 2026/07/30 01:42:16 DEBUG : Setting type="ftp" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_TYPE 2026/07/30 01:42:16 DEBUG : Setting host="172.17.0.4" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2026/07/30 01:42:16 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2026/07/30 01:42:16 DEBUG : Setting pass="HPeh3lXIsEIb5jUKHX-H_298TzHeh1VQRQuMRj0oUaokTw" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2026/07/30 01:42:16 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2026/07/30 01:42:16 DEBUG : TestFTPProftpd: detected overridden config - adding "{v9bBG}" suffix to name 2026/07/30 01:42:16 DEBUG : Setting host="172.17.0.4" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2026/07/30 01:42:16 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2026/07/30 01:42:16 DEBUG : Setting pass="HPeh3lXIsEIb5jUKHX-H_298TzHeh1VQRQuMRj0oUaokTw" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2026/07/30 01:42:16 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: Connecting to FTP server 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:21") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:58662->172.17.0.4:21, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot/List 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:22102") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:54996->172.17.0.4:22102, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:34125") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:55882->172.17.0.4:34125, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:24517") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:51202->172.17.0.4:24517, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:21234") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:57300->172.17.0.4:21234, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:43167") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:57748->172.17.0.4:43167, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot/ListEntries 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:48284") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:36212->172.17.0.4:48284, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot/ListR fstests.go:2024: FS has no ListR interface === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot/Put 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:24433") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:41128->172.17.0.4:24433, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:16270") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:59986->172.17.0.4:16270, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:43069") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:58730->172.17.0.4:43069, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:18260") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:47552->172.17.0.4:18260, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:15376") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:52952->172.17.0.4:15376, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:8116") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:54736->172.17.0.4:8116, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FromRoot/Put/Remove 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:14727") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:48558->172.17.0.4:14727, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:49416") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:47630->172.17.0.4:49416, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:38363") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:58782->172.17.0.4:38363, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:14904") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:35314->172.17.0.4:14904, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: dial("tcp","172.17.0.4:11013") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21: > dial: conn=172.17.0.1:48102->172.17.0.4:11013, err= === RUN TestIntegration/FsMkdir/FsPutFiles/PublicLink fstests.go:2083: FS has no PublicLinker interface === RUN TestIntegration/FsMkdir/FsPutFiles/SetTier fstests.go:431: FS has no SetTier & GetTier interfaces === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectCheckWrap fstests.go:2188: Not a wrapping Fs === RUN TestIntegration/FsMkdir/FsPutFiles/Bucket fstests.go:2204: Not a bucket based backend === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectRemove 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:10071") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:35044->172.17.0.4:10071, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:8080") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:35034->172.17.0.4:8080, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:18384") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:34116->172.17.0.4:18384, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:64945") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:48436->172.17.0.4:64945, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:22848") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:33602->172.17.0.4:22848, err= === RUN TestIntegration/FsMkdir/FsPutFiles/ObjectAbout fstests.go:2360: FS does not support About === RUN TestIntegration/FsMkdir/FsPutFiles/FsPutStream === RUN TestIntegration/FsMkdir/FsPutFiles/FsPutStream/0 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:56588") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:60222->172.17.0.4:56588, err= === RUN TestIntegration/FsMkdir/FsPutFiles/FsPutStream/100 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:22895") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:48396->172.17.0.4:22895, err= === RUN TestIntegration/FsMkdir/FsPutFiles/Internal === RUN TestIntegration/FsMkdir/FsPutFiles/Internal/UploadTimeout 2026/07/30 01:42:16 DEBUG : Creating backend with remote "TestFTPProftpd,concurrency='0',shut_timeout='1s':rclone-test-sunekad6yona" 2026/07/30 01:42:16 DEBUG : Setting type="ftp" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_TYPE 2026/07/30 01:42:16 DEBUG : Setting host="172.17.0.4" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2026/07/30 01:42:16 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2026/07/30 01:42:16 DEBUG : Setting pass="HPeh3lXIsEIb5jUKHX-H_298TzHeh1VQRQuMRj0oUaokTw" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2026/07/30 01:42:16 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2026/07/30 01:42:16 DEBUG : TestFTPProftpd: detected overridden config - adding "{ZXEgb}" suffix to name 2026/07/30 01:42:16 DEBUG : Setting host="172.17.0.4" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2026/07/30 01:42:16 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2026/07/30 01:42:16 DEBUG : Setting pass="HPeh3lXIsEIb5jUKHX-H_298TzHeh1VQRQuMRj0oUaokTw" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2026/07/30 01:42:16 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: Connecting to FTP server 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:21") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:58668->172.17.0.4:21, err= 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:27921") 2026/07/30 01:42:16 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:60292->172.17.0.4:27921, err= === RUN TestIntegration/FsMkdir/FsPutFiles/Internal/TimePrecision === RUN TestIntegration/FsMkdir/FsPutChunked fstests.go:2445: *ftp.Fs does not implement SetUploadChunkSizer === RUN TestIntegration/FsMkdir/FsCopyChunked fstests.go:2557: FS has no Copier interface === RUN TestIntegration/FsMkdir/FsUploadUnknownSize === RUN TestIntegration/FsMkdir/FsUploadUnknownSize/FsPutUnknownSize 2026/07/30 01:42:17 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:10738") 2026/07/30 01:42:17 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:56020->172.17.0.4:10738, err= === RUN TestIntegration/FsMkdir/FsUploadUnknownSize/FsUpdateUnknownSize 2026/07/30 01:42:17 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:61880") 2026/07/30 01:42:17 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:58476->172.17.0.4:61880, err= 2026/07/30 01:42:17 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:59551") 2026/07/30 01:42:17 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:51666->172.17.0.4:59551, err= === RUN TestIntegration/FsMkdir/FsRootCollapse 2026/07/30 01:42:17 DEBUG : Creating backend with remote "TestFTPProftpd:rclone-test-sunekad6yona/deeper/nonexisting/directory" 2026/07/30 01:42:17 DEBUG : Setting type="ftp" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_TYPE 2026/07/30 01:42:17 DEBUG : Setting host="172.17.0.4" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2026/07/30 01:42:17 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2026/07/30 01:42:17 DEBUG : Setting pass="HPeh3lXIsEIb5jUKHX-H_298TzHeh1VQRQuMRj0oUaokTw" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2026/07/30 01:42:17 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2026/07/30 01:42:17 DEBUG : TestFTPProftpd: detected overridden config - adding "{v9bBG}" suffix to name 2026/07/30 01:42:17 DEBUG : Setting host="172.17.0.4" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_HOST 2026/07/30 01:42:17 DEBUG : Setting user="rclone" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_USER 2026/07/30 01:42:17 DEBUG : Setting pass="HPeh3lXIsEIb5jUKHX-H_298TzHeh1VQRQuMRj0oUaokTw" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_PASS 2026/07/30 01:42:17 DEBUG : Setting encoding="Asterisk,Ctl,Dot,Slash" for "TestFTPProftpd" from environment variable RCLONE_CONFIG_TESTFTPPROFTPD_ENCODING 2026/07/30 01:42:17 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/deeper/nonexisting/directory: Connecting to FTP server 2026/07/30 01:42:17 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/deeper/nonexisting/directory: dial("tcp","172.17.0.4:21") 2026/07/30 01:42:17 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona/deeper/nonexisting/directory: > dial: conn=172.17.0.1:58676->172.17.0.4:21, err= === RUN TestIntegration/FsMkdir/FsDirSetModTime fstests.go:2706: FS has no DirSetModTime interface === RUN TestIntegration/FsMkdir/FsMkdirMetadata fstests.go:2749: FS has no MkdirMetadata interface === RUN TestIntegration/FsMkdir/FsDirectory fstests.go:2806: FS has no Directory methods and doesn't Wrap 2026/07/30 01:42:17 DEBUG : Waiting for deletions to finish 2026/07/30 01:42:17 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:37092") 2026/07/30 01:42:17 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:42918->172.17.0.4:37092, err= 2026/07/30 01:42:17 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:24067") 2026/07/30 01:42:17 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:38616->172.17.0.4:24067, err= 2026/07/30 01:42:17 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:19888") 2026/07/30 01:42:17 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:46404->172.17.0.4:19888, err= 2026/07/30 01:42:17 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:28859") 2026/07/30 01:42:17 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:53086->172.17.0.4:28859, err= 2026/07/30 01:42:17 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:28165") 2026/07/30 01:42:17 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:40392->172.17.0.4:28165, err= 2026/07/30 01:42:17 INFO : hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠/z.txt: Deleted 2026/07/30 01:42:17 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:65086") 2026/07/30 01:42:17 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:60780->172.17.0.4:65086, err= 2026/07/30 01:42:17 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:50203") 2026/07/30 01:42:17 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:38392->172.17.0.4:50203, err= 2026/07/30 01:42:17 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:55835") 2026/07/30 01:42:17 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:38372->172.17.0.4:55835, err= 2026/07/30 01:42:17 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:9395") 2026/07/30 01:42:17 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:43704->172.17.0.4:9395, err= 2026/07/30 01:42:17 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:41254") 2026/07/30 01:42:17 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:51732->172.17.0.4:41254, err= 2026/07/30 01:42:17 DEBUG : removing 1 level 4 directories 2026/07/30 01:42:17 INFO : hello? sausage/êé/Hello, 世界/ " ' @ < > & ? + ≠: Removing directory 2026/07/30 01:42:17 DEBUG : removing 1 level 3 directories 2026/07/30 01:42:17 INFO : hello? sausage/êé/Hello, 世界: Removing directory 2026/07/30 01:42:17 DEBUG : removing 1 level 2 directories 2026/07/30 01:42:17 INFO : hello? sausage/êé: Removing directory 2026/07/30 01:42:17 DEBUG : removing 1 level 1 directories 2026/07/30 01:42:17 INFO : hello? sausage: Removing directory 2026/07/30 01:42:17 DEBUG : removing 1 level 0 directories 2026/07/30 01:42:17 INFO : ftp://172.17.0.4:21/rclone-test-sunekad6yona: Removing directory 2026/07/30 01:42:17 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:20276") 2026/07/30 01:42:17 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:37912->172.17.0.4:20276, err= 2026/07/30 01:42:17 ERROR : error listing: directory not found 2026/07/30 01:42:17 DEBUG : Waiting for deletions to finish 2026/07/30 01:42:17 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:13378") 2026/07/30 01:42:17 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:48386->172.17.0.4:13378, err= 2026/07/30 01:42:17 ERROR : error listing: directory not found 2026/07/30 01:42:17 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: dial("tcp","172.17.0.4:46093") 2026/07/30 01:42:17 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: > dial: conn=172.17.0.1:49456->172.17.0.4:46093, err= 2026/07/30 01:42:17 ERROR : ftp://172.17.0.4:21/rclone-test-sunekad6yona: Failed to list "": directory not found 2026/07/30 01:42:17 DEBUG : removing 1 level 0 directories 2026/07/30 01:42:17 INFO : ftp://172.17.0.4:21/rclone-test-sunekad6yona: Removing directory 2026/07/30 01:42:17 ERROR : Failed to rmdir: directory not found === RUN TestIntegration/FsShutdown 2026/07/30 01:42:17 DEBUG : ftp://172.17.0.4:21/rclone-test-sunekad6yona: closing 2 unused connections 2026/07/30 01:42:17 NOTICE: TestFTPProftpd: Stopping server --- PASS: TestIntegration (4.19s) --- 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.87s) --- 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.21s) --- PASS: TestIntegration/FsMkdir/FsEncoding/control_chars (0.01s) --- 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.15s) --- 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.41s) --- 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.00s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FsListRSubdir#01 (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListLevel2 (0.00s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FsListRLevel2 (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListFile1 (0.01s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsNewObject (0.00s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FsNewObjectCaseInsensitive (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListFile1and2 (0.01s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsNewObjectDir (0.00s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FsPurge (0.00s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FsPurgeRoot (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsListRootedSubdir (0.07s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FsCopy (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsMove (0.06s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/FsMove/Metadata (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsDirMove (0.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/ObjectOpenFingerprint (0.07s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectOpenFingerprint/full_read (0.01s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectOpenFingerprint/seek_read (0.01s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectOpenFingerprint/range_read (0.01s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectOpenFingerprint/range_read_to_end (0.01s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/ObjectOpenFingerprint/refresh (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.01s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FromRoot (0.05s) --- 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.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.01s) --- SKIP: TestIntegration/FsMkdir/FsPutFiles/ObjectAbout (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsPutStream (0.01s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsPutStream/0 (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/FsPutStream/100 (0.00s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/Internal (0.86s) --- PASS: TestIntegration/FsMkdir/FsPutFiles/Internal/UploadTimeout (0.86s) --- 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.214s "go test -v -timeout 1h0m0s -remote TestFTPProftpd: -verbose" - Finished OK in 5.719832914s (try 1/5)