Re: [Proftpd-user] mod_sftp slowness - how can I track this down

Michel van der List <[email protected]> Tue, 16 Feb 2021 19:46:58 -0500
Newsgroups gmane.network.proftpd.user
Message-ID <[email protected]>
Turning off selinux did not help. I then did Trace DEFAULT:10
in the config and looked at the file io and it seems to just take
a long time to enumerate the files, part of the trace below. Maybe
the getpwnam call is the culprit?

2021-02-16 19:31:55,510 [1493] <fsio:8>: using system readdir()
2021-02-16 19:31:55,510 [1493] <fsio:8>: using system lstat() for path '/testing/.ftpaccess'
2021-02-16 19:31:55,510 [1493] <fsio:8>: using system lstat() for path '/testing/.ftpaccess'
2021-02-16 19:31:55,510 [1493] <fsio:8>: using system stat() for path '/testing/.ftpaccess'
2021-02-16 19:31:55,510 [1493] <fsio:8>: using system stat() for path '/testing/.ftpaccess'
2021-02-16 19:31:55,510 [1493] <fsio:8>: using system stat() for path '/testing/.ftpaccess'
2021-02-16 19:31:55,510 [1493] <fsio:8>: using system stat() for path '/.ftpaccess'
2021-02-16 19:31:55,510 [1493] <auth:6>: dispatching auth request "getpwnam" to module mod_auth_file
2021-02-16 19:31:55,555 [1493] <auth:6>: dispatching auth request "getpwnam" to module mod_auth_unix
2021-02-16 19:31:55,555 [1493] <auth:5>: stashed module 'mod_auth_unix.c' for user 'nobody' in the authcache
2021-02-16 19:31:55,555 [1493] <fsio:8>: using system readdir()
2021-02-16 19:31:55,555 [1493] <fsio:8>: using system lstat() for path '/testing/zpvq0UZ4Tbhwd5uj.txt'
2021-02-16 19:31:55,555 [1493] <fsio:8>: using system lstat() for path '/testing/zpvq0UZ4Tbhwd5uj.txt'
2021-02-16 19:31:55,555 [1493] <fsio:8>: using system stat() for path '/testing/zpvq0UZ4Tbhwd5uj.txt'
2021-02-16 19:31:55,555 [1493] <fsio:8>: using system stat() for path '/testing/zpvq0UZ4Tbhwd5uj.txt'
2021-02-16 19:31:55,555 [1493] <fsio:8>: using system stat() for path '/testing/.ftpaccess'
2021-02-16 19:31:55,555 [1493] <auth:6>: dispatching auth request "getpwnam" to module mod_auth_file
2021-02-16 19:31:55,599 [1493] <auth:6>: dispatching auth request "getpwnam" to module mod_auth_unix
2021-02-16 19:31:55,599 [1493] <auth:5>: stashed module 'mod_auth_unix.c' for user 'nobody' in the authcache
2021-02-16 19:31:55,599 [1493] <fsio:8>: using system readdir()
2021-02-16 19:31:55,599 [1493] <fsio:8>: using system lstat() for path '/testing/BpX0iNjFornFYBzN.txt'
2021-02-16 19:31:55,599 [1493] <fsio:8>: using system lstat() for path '/testing/BpX0iNjFornFYBzN.txt'
2021-02-16 19:31:55,599 [1493] <fsio:8>: using system stat() for path '/testing/BpX0iNjFornFYBzN.txt'
2021-02-16 19:31:55,599 [1493] <fsio:8>: using system stat() for path '/testing/BpX0iNjFornFYBzN.txt'
2021-02-16 19:31:55,599 [1493] <fsio:8>: using system stat() for path '/testing/.ftpaccess'
2021-02-16 19:31:55,599 [1493] <auth:6>: dispatching auth request "getpwnam" to module mod_auth_file
2021-02-16 19:31:55,644 [1493] <auth:6>: dispatching auth request "getpwnam" to module mod_auth_unix
2021-02-16 19:31:55,644 [1493] <auth:5>: stashed module 'mod_auth_unix.c' for user 'nobody' in the authcache
2021-02-16 19:31:55,644 [1493] <fsio:8>: using system readdir()
2021-02-16 19:31:55,644 [1493] <fsio:8>: using system lstat() for path '/testing/Z83S324uH5OVqE0h.txt'
2021-02-16 19:31:55,644 [1493] <fsio:8>: using system lstat() for path '/testing/Z83S324uH5OVqE0h.txt'
2021-02-16 19:31:55,644 [1493] <fsio:8>: using system stat() for path '/testing/Z83S324uH5OVqE0h.txt'
2021-02-16 19:31:55,644 [1493] <fsio:8>: using system stat() for path '/testing/Z83S324uH5OVqE0h.txt'
2021-02-16 19:31:55,644 [1493] <fsio:8>: using system stat() for path '/testing/.ftpaccess'

...

2021-02-16 19:32:04,536 [1493] <fsio:8>: using system lstat() for path '/testing/HoWoxPGKqh3PvjCa.txt'
2021-02-16 19:32:04,536 [1493] <fsio:8>: using system lstat() for path '/testing/HoWoxPGKqh3PvjCa.txt'
2021-02-16 19:32:04,536 [1493] <fsio:8>: using system stat() for path '/testing/HoWoxPGKqh3PvjCa.txt'
2021-02-16 19:32:04,536 [1493] <fsio:8>: using system stat() for path '/testing/HoWoxPGKqh3PvjCa.txt'
2021-02-16 19:32:04,536 [1493] <fsio:8>: using system stat() for path '/testing/.ftpaccess'
2021-02-16 19:32:04,537 [1493] <auth:6>: dispatching auth request "getpwnam" to module mod_auth_file
2021-02-16 19:32:04,582 [1493] <auth:6>: dispatching auth request "getpwnam" to module mod_auth_unix
2021-02-16 19:32:04,582 [1493] <auth:5>: stashed module 'mod_auth_unix.c' for user 'nobody' in the authcache
2021-02-16 19:32:04,582 [1493] <fsio:8>: using system readdir()
2021-02-16 19:32:04,582 [1493] <timer:7>: reset timer ID 3 ('TimeoutNoTransfer', for module 'xfer')
2021-02-16 19:32:04,582 [1493] <timer:7>: reset timer ID 4 ('TimeoutStalled', for module '[none]')



_______________________________________________
ProFTPD Users List   <[email protected]>
Unsubscribe problems?
http://www.proftpd.org/list-unsub.html