Menu
▾
▴
[Fetchmail-users] somehow broke fetchmail trying to fix outgoing email :(
|
From: Abe S. <abe...@uc...> - 2020-10-02 07:01:58
|
Hi, When I got up this morning I found that my outgoing mail wasn't working. Of course that had nothing to do with fetchmail, and I was still able to retrieve my mail from gmail using POP3 as usual. I spent most of the day getting the outgoing mail to work again. But now I find that fetchmail can't deliver the incoming mail locally anymore. I get "smtp listener protocol error." The weird thing is, even when I change main.cf back to what it was before (which would break my outgoing mail again, but never mind that), the problem persists. I'm running fetchmail 6.4.4 on Mac OS 10.13.6 (High Sierra). The verbose fetchmail log looks like this (as you can see, everything works fine until it tries to deliver locally): fetchmail: 6.4.4 querying pop.gmail.com (protocol POP3) at Thu, 01 Oct 2020 21:50:34 -0700 (PDT): poll started fetchmail: Trying to connect to 108.177.98.108/995...connected. fetchmail: Server certificate: fetchmail: Issuer Organization: Google Trust Services fetchmail: Issuer CommonName: GTS CA 1O1 fetchmail: Subject CommonName: pop.gmail.com fetchmail: Subject Alternative Name: pop.gmail.com fetchmail: pop.gmail.com key fingerprint: 80:74:2A:92:40:2C:6E:B2:82:95:8F:EF:E5:74:61:BD fetchmail: SSL/TLS: using protocol TLSv1.3, cipher TLS_AES_256_GCM_SHA384, 256/256 secret/processed bits fetchmail: POP3< +OK Gpop ready for requests from 135.180.12.77 t18mb74240021ioi fetchmail: POP3> CAPA fetchmail: POP3< +OK Capability list follows fetchmail: POP3< USER fetchmail: POP3< RESP-CODES fetchmail: POP3< EXPIRE 0 fetchmail: POP3< LOGIN-DELAY 300 fetchmail: POP3< TOP fetchmail: POP3< UIDL fetchmail: POP3< X-GOOGLE-RICO fetchmail: POP3< SASL PLAIN XOAUTH2 OAUTHBEARER fetchmail: POP3< . fetchmail: POP3> USER abe...@gm... fetchmail: POP3< +OK send PASS fetchmail: POP3> PASS * fetchmail: POP3< +OK Welcome. fetchmail: POP3> STAT fetchmail: POP3< +OK 59 2750128 fetchmail: 59 messages for abe...@gm... at pop.gmail.com (2750128 octets). fetchmail: POP3> LIST 1 fetchmail: POP3< +OK 1 35221 fetchmail: POP3> RETR 1 fetchmail: POP3< +OK message follows fetchmail: reading message abe...@gm...@pop.gmail.com:1 of 59 (35221 octets)Trying to connect to 127.0.0.1/25...connected. fetchmail: smtp listener protocol error fetchmail: Trying to connect to 127.0.0.1/25...connected. fetchmail: smtp listener protocol error fetchmail: SMTP connect to localhost failed fetchmail: POP3> QUIT fetchmail: POP3< --Mjk5MjIxMDM3OTAzNjQ2MDg fetchmail: SMTP transaction error while fetching from abe...@gm...@pop.gmail.com and delivering to SMTP host localhost fetchmail: 6.4.4 querying pop.gmail.com (protocol POP3) at Thu, 01 Oct 2020 22:00:35 -0700 (PDT): poll completed fetchmail: Query status=10 (SMTP) fetchmail: normal termination, status 10 The verbose log from smtpd looks like this: 2020-10-01 21:50:35.514198-0700 0x72ee Info 0x0 1414 smtp: unknown_stream: wanted attribute: (any attribute name or list terminator) 2020-10-01 21:50:35.514284-0700 0x72ee Info 0x0 1414 smtp: input attribute name: client_address 2020-10-01 21:50:35.514358-0700 0x72ee Info 0x0 1414 smtp: input attribute value: 127.0.0.1 2020-10-01 21:50:35.514407-0700 0x72ee Info 0x0 1414 smtp: unknown_stream: wanted attribute: (any attribute name or list terminator) 2020-10-01 21:50:35.514451-0700 0x72ee Info 0x0 1414 smtp: input attribute name: client_port 2020-10-01 21:50:35.514491-0700 0x72ee Info 0x0 1414 smtp: input attribute value: 50368 2020-10-01 21:50:35.514531-0700 0x72ee Info 0x0 1414 smtp: unknown_stream: wanted attribute: (any attribute name or list terminator) 2020-10-01 21:50:35.514569-0700 0x72ee Info 0x0 1414 smtp: input attribute name: server_address 2020-10-01 21:50:35.514605-0700 0x72ee Info 0x0 1414 smtp: input attribute value: 127.0.0.1 2020-10-01 21:50:35.514644-0700 0x72ee Info 0x0 1414 smtp: unknown_stream: wanted attribute: (any attribute name or list terminator) 2020-10-01 21:50:35.514681-0700 0x72ee Info 0x0 1414 smtp: input attribute name: server_port 2020-10-01 21:50:35.514718-0700 0x72ee Info 0x0 1414 smtp: input attribute value: 25 2020-10-01 21:50:35.514799-0700 0x72ee Info 0x0 1414 smtp: unknown_stream: wanted attribute: (any attribute name or list terminator) 2020-10-01 21:50:35.514876-0700 0x72ee Info 0x0 1414 smtp: input attribute name: (end) 2020-10-01 21:50:35.515437-0700 0x72ee Info 0x0 1414 smtp: connection established 2020-10-01 21:50:35.515588-0700 0x72ee Info 0x0 1414 smtp: master_notify: status 0 2020-10-01 21:50:35.515790-0700 0x72ee Info 0x0 1414 smtp: deliver_request_initial: send initial status 2020-10-01 21:50:35.515918-0700 0x72ee Info 0x0 1414 smtp: send attr status = 0 2020-10-01 21:55:35.535124-0700 0x72ee Info 0x0 1414 smtp: master_notify: status 1 2020-10-01 21:55:35.535214-0700 0x72ee Info 0x0 1414 smtp: connection closed 2020-10-01 21:55:35.608088-0700 0x72ee Info 0x0 1414 smtp: unknown_stream: wanted attribute: (any attribute name or list terminator) 2020-10-01 21:55:35.608128-0700 0x72ee Info 0x0 1414 smtp: input attribute name: client_address 2020-10-01 21:55:35.608156-0700 0x72ee Info 0x0 1414 smtp: input attribute value: 127.0.0.1 2020-10-01 21:55:35.608198-0700 0x72ee Info 0x0 1414 smtp: unknown_stream: wanted attribute: (any attribute name or list terminator) 2020-10-01 21:55:35.608260-0700 0x72ee Info 0x0 1414 smtp: input attribute name: client_port 2020-10-01 21:55:35.608309-0700 0x72ee Info 0x0 1414 smtp: input attribute value: 50664 2020-10-01 21:55:35.608358-0700 0x72ee Info 0x0 1414 smtp: unknown_stream: wanted attribute: (any attribute name or list terminator) 2020-10-01 21:55:35.608407-0700 0x72ee Info 0x0 1414 smtp: input attribute name: server_address 2020-10-01 21:55:35.608453-0700 0x72ee Info 0x0 1414 smtp: input attribute value: 127.0.0.1 2020-10-01 21:55:35.608525-0700 0x72ee Info 0x0 1414 smtp: unknown_stream: wanted attribute: (any attribute name or list terminator) 2020-10-01 21:55:35.608572-0700 0x72ee Info 0x0 1414 smtp: input attribute name: server_port 2020-10-01 21:55:35.608616-0700 0x72ee Info 0x0 1414 smtp: input attribute value: 25 2020-10-01 21:55:35.608661-0700 0x72ee Info 0x0 1414 smtp: unknown_stream: wanted attribute: (any attribute name or list terminator) 2020-10-01 21:55:35.608705-0700 0x72ee Info 0x0 1414 smtp: input attribute name: (end) 2020-10-01 21:55:35.608915-0700 0x72ee Info 0x0 1414 smtp: connection established 2020-10-01 21:55:35.608986-0700 0x72ee Info 0x0 1414 smtp: master_notify: status 0 2020-10-01 21:55:35.609031-0700 0x72ee Info 0x0 1414 smtp: deliver_request_initial: send initial status 2020-10-01 21:55:35.609075-0700 0x72ee Info 0x0 1414 smtp: send attr status = 0 2020-10-01 22:00:35.554329-0700 0x72ee Info 0x0 1414 smtp: master_notify: status 1 2020-10-01 22:00:35.554409-0700 0x72ee Info 0x0 1414 smtp: connection closed 2020-10-01 22:02:15.557521-0700 0x72ee Info 0x0 1414 smtp: idle timeout -- exiting The lines I changed in main.cf were relayhost (switched from smtp.gmail.com to my ISP's smtp server) and the stuff about TLS, SASL, etc. The old one had: smtp_use_tls = yes smtp_sasl_auth_enable = yes smtp_sasl_mechanism_filter = plain smtp_sasl_security_options = smtp_sasl_password_maps = hash:/etc/postfix/sasl_passwd smtp_tls_security_level = encrypt The new one has: smtp_use_tls = yes smtp_sasl_auth_enable = yes smtp_tls_security_level = encrypt smtp_sasl_tls_security_options = noanonymous smtp_sasl_mechanism_filter = login smtp_sasl_security_options = smtp_sasl_password_maps = hash:/etc/postfix/sasl_passwd smtp_tls_wrappermode = yes But, as I said, even when I change back to the old main.cf, fetchmail still doesn't work. (The above logs were generated using the *old* main.cf.) I have reloaded postfix many times and even rebooted. Any help would be appreciated. Thank you, -- Abe Stone abe...@uc... |
