FlashFXP Forums - View Single Post

pion · 05-04-2010, 03:24 AM

Bad news - io 745 is not working proper without nxmydb either.

(10:08:02) [glftpd] Reversed FXP started
(10:08:02) [io745] CPSV
(10:08:02) [io745] 226-Transferred: 0.
(10:08:02) [io745] 426 Connection closed: Connection timed out.
(10:08:02) [io745] 226 ABOR command successful.
(10:08:02) [io745] 227 Entering Passive Mode (1,1,1,1,65,54)
(10:08:02) [glftpd] PORT 1,1,1,1,65,54
(10:08:02) [glftpd] 200 PORT command successful.
(10:08:02) [io745] STOR file.r27
(10:08:03) [io745] 150 Opening BINARY mode data connection for file.r27 using SSL/TLS.
(10:08:03) [glftpd] RETR file.r27
(10:08:03) [glftpd] 150 Opening BINARY mode data connection for file.r27 (15000000 bytes) using SSL/TLS.
(10:08:22) [glftpd] 435 Failed TLS negotiation on data channel (using SSL_accept()), disconnected: Connection reset by peer.
(10:08:22) [glftpd] Reversed FXP started
(10:08:22) [io745] CPSV
(10:08:22) [io745] 226-Transferred: 0.
(10:08:22) [io745] 426 Connection closed: Connection timed out.
(10:08:22) [io745] 226 ABOR command successful.
(10:08:22) [io745] 227 Entering Passive Mode (1,1,1,1,66,140)
(10:08:22) [glftpd] PORT 1,1,1,1,66,140
(10:08:22) [glftpd] 200 PORT command successful.
(10:08:22) [io745] STOR file.r27
(10:08:23) [io745] 150 Opening BINARY mode data connection for file.r27 using SSL/TLS.
(10:08:23) [glftpd] RETR file.r27
(10:08:23) [glftpd] 150 Opening BINARY mode data connection for file.r27 (15000000 bytes) using SSL/TLS.
(10:08:42) [glftpd] 435 Failed TLS negotiation on data channel (using SSL_accept()), disconnected: Connection reset by peer.

(10:03:22) [io703] Reversed FXP started
(10:03:22) [io745] 226-Transferred: 0.
(10:03:22) [io745] 426 Connection closed: Connection timed out.
(10:03:22) [io745] CPSV
(10:03:22) [io745] 226 ABOR command successful.
(10:03:22) [io745] 227 Entering Passive Mode (1,1,1,1,61,26)
(10:03:22) [io703] PORT 1,1,1,1,61,26
(10:03:22) [io703] 200 PORT command successful.
(10:03:22) [io745] STOR myfile.r09
(10:03:23) [io745] 150 Opening BINARY mode data connection for myfile.r09 using SSL/TLS.
(10:03:23) [io703] RETR myfile.r09
(10:03:23) [io703] 150 Opening BINARY mode data connection for myfile.r09 (14648 bytes) using SSL/TLS.
(10:03:43) [io703] 426 Connection closed: The specified network name is no longer available.
(10:03:43) [io703] Reversed FXP started
(10:03:43) [io745] 226-Transferred: 0.
(10:03:43) [io745] 426 Connection closed: Connection timed out.
(10:03:43) [io745] CPSV
(10:03:43) [io745] 226 ABOR command successful.
(10:03:43) [io745] 227 Entering Passive Mode (1,1,1,1,63,54)
(10:03:43) [io703] PORT 1,1,1,1,63,54
(10:03:43) [io703] 200 PORT command successful.
(10:03:43) [io745] STOR myfile.r09
(10:03:44) [io745] 150 Opening BINARY mode data connection for myfile.r09 using SSL/TLS.
(10:03:44) [io703] RETR myfile.r09
(10:03:44) [io703] 150 Opening BINARY mode data connection for myfile.r09 (14648 bytes) using SSL/TLS.
(10:04:04) [io703] 426 Connection closed: The specified network name is no longer available.

(10:18:38) [io745] STAT -l
(10:18:38) [io745] List Complete: 4*405 bytes in 0,11 seconds (40,05KB/s)
(10:18:42) [io745] PASV
(10:18:42) [io745] 227 Entering Passive Mode (1,1,1,1,63,227)
(10:18:43) [io745] RETR 6kbfile.nfo
(10:18:43) [io745] 150 Opening ASCII mode data connection for 6kbfile.nfo (5857 bytes) using SSL/TLS.
(10:18:57) [io745] ABOR
(10:18:57) [io745] Can't open data connection
(10:18:57) [io745] PASV
(10:18:58) [io745] 550-Init: 1, Aborted: 1, Socket: -1, LastError: 20500, Size: 5857, Pos: 240518168576
(10:18:58) [io745] 550 Active transfer in progress, terminate transfer with ABOR before proceeding.
(10:18:58) [io745] Connecting to io745

This behaviour repeats itself over and over and over and over for hours and hours - so it's clearly crashed. This is in fact, the excact same behaviour as the hangup bug, where it becomes impossible to connect to the ftpd after a while, except this time I can still connect, just not transfer anything. Upload, download, fxp to and from, from any type of daemon at the other side.

When issuing 'site crashnow' it does nothing other than write an entry in ioftpd.log (I could log in just fine in a new session)

When I attached windbg, io stopped accepting connections. However, once detached, io accepted connections again, but not a single transfer goes through.

Only upside to this is that I got a new dump for you..

05-04-2010, 03:24 AM
pion Senior Member Join Date: Feb 2006 Posts: 138	Bad news - io 745 is not working proper without nxmydb either. (10:08:02) [glftpd] Reversed FXP started (10:08:02) [io745] CPSV (10:08:02) [io745] 226-Transferred: 0. (10:08:02) [io745] 426 Connection closed: Connection timed out. (10:08:02) [io745] 226 ABOR command successful. (10:08:02) [io745] 227 Entering Passive Mode (1,1,1,1,65,54) (10:08:02) [glftpd] PORT 1,1,1,1,65,54 (10:08:02) [glftpd] 200 PORT command successful. (10:08:02) [io745] STOR file.r27 (10:08:03) [io745] 150 Opening BINARY mode data connection for file.r27 using SSL/TLS. (10:08:03) [glftpd] RETR file.r27 (10:08:03) [glftpd] 150 Opening BINARY mode data connection for file.r27 (15000000 bytes) using SSL/TLS. (10:08:22) [glftpd] 435 Failed TLS negotiation on data channel (using SSL_accept()), disconnected: Connection reset by peer. (10:08:22) [glftpd] Reversed FXP started (10:08:22) [io745] CPSV (10:08:22) [io745] 226-Transferred: 0. (10:08:22) [io745] 426 Connection closed: Connection timed out. (10:08:22) [io745] 226 ABOR command successful. (10:08:22) [io745] 227 Entering Passive Mode (1,1,1,1,66,140) (10:08:22) [glftpd] PORT 1,1,1,1,66,140 (10:08:22) [glftpd] 200 PORT command successful. (10:08:22) [io745] STOR file.r27 (10:08:23) [io745] 150 Opening BINARY mode data connection for file.r27 using SSL/TLS. (10:08:23) [glftpd] RETR file.r27 (10:08:23) [glftpd] 150 Opening BINARY mode data connection for file.r27 (15000000 bytes) using SSL/TLS. (10:08:42) [glftpd] 435 Failed TLS negotiation on data channel (using SSL_accept()), disconnected: Connection reset by peer. (10:03:22) [io703] Reversed FXP started (10:03:22) [io745] 226-Transferred: 0. (10:03:22) [io745] 426 Connection closed: Connection timed out. (10:03:22) [io745] CPSV (10:03:22) [io745] 226 ABOR command successful. (10:03:22) [io745] 227 Entering Passive Mode (1,1,1,1,61,26) (10:03:22) [io703] PORT 1,1,1,1,61,26 (10:03:22) [io703] 200 PORT command successful. (10:03:22) [io745] STOR myfile.r09 (10:03:23) [io745] 150 Opening BINARY mode data connection for myfile.r09 using SSL/TLS. (10:03:23) [io703] RETR myfile.r09 (10:03:23) [io703] 150 Opening BINARY mode data connection for myfile.r09 (14648 bytes) using SSL/TLS. (10:03:43) [io703] 426 Connection closed: The specified network name is no longer available. (10:03:43) [io703] Reversed FXP started (10:03:43) [io745] 226-Transferred: 0. (10:03:43) [io745] 426 Connection closed: Connection timed out. (10:03:43) [io745] CPSV (10:03:43) [io745] 226 ABOR command successful. (10:03:43) [io745] 227 Entering Passive Mode (1,1,1,1,63,54) (10:03:43) [io703] PORT 1,1,1,1,63,54 (10:03:43) [io703] 200 PORT command successful. (10:03:43) [io745] STOR myfile.r09 (10:03:44) [io745] 150 Opening BINARY mode data connection for myfile.r09 using SSL/TLS. (10:03:44) [io703] RETR myfile.r09 (10:03:44) [io703] 150 Opening BINARY mode data connection for myfile.r09 (14648 bytes) using SSL/TLS. (10:04:04) [io703] 426 Connection closed: The specified network name is no longer available. (10:18:38) [io745] STAT -l (10:18:38) [io745] List Complete: 4*405 bytes in 0,11 seconds (40,05KB/s) (10:18:42) [io745] PASV (10:18:42) [io745] 227 Entering Passive Mode (1,1,1,1,63,227) (10:18:43) [io745] RETR 6kbfile.nfo (10:18:43) [io745] 150 Opening ASCII mode data connection for 6kbfile.nfo (5857 bytes) using SSL/TLS. (10:18:57) [io745] ABOR (10:18:57) [io745] Can't open data connection (10:18:57) [io745] PASV (10:18:58) [io745] 550-Init: 1, Aborted: 1, Socket: -1, LastError: 20500, Size: 5857, Pos: 240518168576 (10:18:58) [io745] 550 Active transfer in progress, terminate transfer with ABOR before proceeding. (10:18:58) [io745] Connecting to io745 This behaviour repeats itself over and over and over and over for hours and hours - so it's clearly crashed. This is in fact, the excact same behaviour as the hangup bug, where it becomes impossible to connect to the ftpd after a while, except this time I can still connect, just not transfer anything. Upload, download, fxp to and from, from any type of daemon at the other side. When issuing 'site crashnow' it does nothing other than write an entry in ioftpd.log (I could log in just fine in a new session) When I attached windbg, io stopped accepting connections. However, once detached, io accepted connections again, but not a single transfer goes through. Only upside to this is that I got a new dump for you..