unable to send mail with postfix use mail client

6 posts / 0 new
Topic locked
Last post
#1 Wed, 08/20/2008 - 15:08
fchavez

unable to send mail with postfix use mail client

I cant seem to figure out why in Ubuntu 8.04 Lts Postfix doesnt let me send mail from a mail client, it works well with the webmin online client but from a mail client like "Apple Mail" it tells me that the server rejected the password. i ran the command postconf -a to see what postfix was compiled with support for SASL authentication, The server replied with cyrus and dovecot. i dont know if that means it has SASL authentication.

Please help me, let me know if i am atleast on the right track.

Any help would be appreciated.

Wed, 08/20/2008 - 19:08
andreychek

You might want to look in /var/log/auth.log and /var/log/mail.log -- both could offer some tidbits on what the problem is.

You may also want to verify that saslauthd is running (/etc/init.d/saslauthd restart).
-Eric

Wed, 08/20/2008 - 19:26
fchavez

I checked to see if saslauthd was running and it was and i restarted it also to see if it was ok and its fine. i am going to post the log files to see if it helps.

/var/log/auth.log
[code:1]Aug 20 21:12:01 LazerNet-Hosting CRON[15499]: pam_unix(cron:«»session): session opened for user root by (uid=0)
Aug 20 21:12:07 LazerNet-Hosting CRON[15499]: pam_unix(cron:«»session): session closed for user root
Aug 20 21:15:01 LazerNet-Hosting CRON[15612]: pam_unix(cron:«»session): session opened for user root by (uid=0)
Aug 20 21:15:02 LazerNet-Hosting su[15626]: Successful su for postgres by root
Aug 20 21:15:02 LazerNet-Hosting su[15626]: + ??? root:«»postgres
Aug 20 21:15:02 LazerNet-Hosting su[15626]: pam_unix(su:«»session): session opened for user postgres by (uid=0)
Aug 20 21:15:02 LazerNet-Hosting su[15626]: pam_unix(su:«»session): session closed for user postgres
Aug 20 21:15:13 LazerNet-Hosting CRON[15612]: pam_unix(cron:«»session): session closed for user root
Aug 20 21:17:01 LazerNet-Hosting CRON[15645]: pam_unix(cron:«»session): session opened for user root by (uid=0)
Aug 20 21:17:01 LazerNet-Hosting CRON[15645]: pam_unix(cron:«»session): session closed for user root
Aug 20 21:17:01 LazerNet-Hosting CRON[15647]: pam_unix(cron:«»session): session opened for user root by (uid=0)
Aug 20 21:17:18 LazerNet-Hosting CRON[15647]: pam_unix(cron:«»session): session closed for user root
Aug 20 21:18:44 LazerNet-Hosting sshd[15770]: Address 192.168.1.5 maps to charlie-brown.local, but this does not map back to the address - POSSIBLE BREAK-IN ATTEMPT!
Aug 20 21:18:47 LazerNet-Hosting sshd[15770]: Accepted password for administrator from 192.168.1.5 port 51440 ssh2
Aug 20 21:18:47 LazerNet-Hosting sshd[15772]: pam_unix(sshd:«»session): session opened for user administrator by (uid=0)
Aug 20 21:19:49 LazerNet-Hosting perl: pam_unix(webmin:«»session): session opened for user administrator by (uid=0)
Aug 20 21:19:49 LazerNet-Hosting sudo: administrator : TTY=pts/1 ; PWD=/usr/share/webmin ; USER=root ; COMMAND=list
Aug 20 21:19:49 LazerNet-Hosting webmin[15793]: Successful login as administrator from 67.188.22.253
Aug 20 21:20:01 LazerNet-Hosting CRON[15808]: pam_unix(cron:«»session): session opened for user www-data by (uid=0)
Aug 20 21:20:01 LazerNet-Hosting CRON[15808]: pam_unix(cron:«»session): session closed for user www-data
Aug 20 21:20:01 LazerNet-Hosting CRON[15810]: pam_unix(cron:«»session): session opened for user root by (uid=0)
Aug 20 21:20:02 LazerNet-Hosting su[15824]: Successful su for postgres by root
Aug 20 21:20:02 LazerNet-Hosting su[15824]: + ??? root:«»postgres
Aug 20 21:20:02 LazerNet-Hosting su[15824]: pam_unix(su:«»session): session opened for user postgres by (uid=0)
Aug 20 21:20:02 LazerNet-Hosting su[15824]: pam_unix(su:«»session): session closed for user postgres
Aug 20 21:20:13 LazerNet-Hosting CRON[15810]: pam_unix(cron:«»session): session closed for user root
Aug 20 21:20:28 LazerNet-Hosting saslauthd[5888]: server_exit : master exited: 5888
Aug 20 21:20:28 LazerNet-Hosting saslauthd[15875]: detach_tty : master pid is: 15875
Aug 20 21:20:28 LazerNet-Hosting saslauthd[15875]: ipc_init : listening on socket: /var/spool/postfix/var/run/saslauthd/mux
Aug 20 21:22:01 LazerNet-Hosting CRON[15899]: pam_unix(cron:«»session): session opened for user root by (uid=0)[/code:1]

/var/log/mail.log
[code:1]
Aug 20 21:16:24 LazerNet-Hosting postfix/anvil[15601]: statistics: max cache size 1 at Aug 20 21:13:04
Aug 20 21:16:24 LazerNet-Hosting postfix/smtp[15641]: 6E9D18121DE: host mx-9.zoominternet.net[72.23.14.20] refused to talk to me: 550 Blocked by RBL. See blocked by RBL - see http://www.mail-abuse.com/cgi-bin/lookup?ip_address=67.188.22.253
Aug 20 21:16:29 LazerNet-Hosting postfix/smtp[15641]: 6E9D18121DE: host mx-3.zoominternet.net[24.154.1.22] refused to talk to me: 550 Blocked by RBL. See blocked by RBL - see http://www.mail-abuse.com/cgi-bin/lookup?ip_address=67.188.22.253
Aug 20 21:16:34 LazerNet-Hosting postfix/smtp[15641]: 6E9D18121DE: to=<afriedrick@zoominternet.net>, relay=mx-2.zoominternet.net[24.154.1.76]:25, delay=954, delays=928/0.01/26/0, dsn=4.0.0, status=deferred (host mx-2.zoominternet.net[24.154.1.76] refused to talk to me: 550 Blocked by RBL. See blocked by RBL - see http://www.mail-abuse.com/cgi-bin/lookup?ip_address=67.188.22.253)
Aug 20 21:20:13 LazerNet-Hosting dovecot: imap-login: Disconnected: rip=192.168.1.6, lip=192.168.1.6, secured
Aug 20 21:20:13 LazerNet-Hosting dovecot: imap-login: Disconnected: rip=192.168.1.6, lip=192.168.1.6, secured
Aug 20 21:20:37 LazerNet-Hosting postfix/smtpd[15882]: connect from c-67-188-22-253.hsd1.ca.comcast.net[67.188.22.253]
Aug 20 21:20:37 LazerNet-Hosting postfix/smtpd[15882]: warning: SASL authentication failure: cannot connect to saslauthd server: Permission denied
Aug 20 21:20:37 LazerNet-Hosting postfix/smtpd[15882]: warning: SASL authentication failure: Password verification failed
Aug 20 21:20:37 LazerNet-Hosting postfix/smtpd[15882]: warning: c-67-188-22-253.hsd1.ca.comcast.net[67.188.22.253]: SASL PLAIN authentication failed: generic failure
Aug 20 21:20:37 LazerNet-Hosting postfix/smtpd[15882]: lost connection after AUTH from c-67-188-22-253.hsd1.ca.comcast.net[67.188.22.253]
Aug 20 21:20:37 LazerNet-Hosting postfix/smtpd[15882]: disconnect from c-67-188-22-253.hsd1.ca.comcast.net[67.188.22.253]
Aug 20 21:20:41 LazerNet-Hosting postfix/smtpd[15882]: connect from c-67-188-22-253.hsd1.ca.comcast.net[67.188.22.253]
Aug 20 21:20:41 LazerNet-Hosting postfix/smtpd[15882]: warning: SASL authentication failure: cannot connect to saslauthd server: Permission denied
Aug 20 21:20:41 LazerNet-Hosting postfix/smtpd[15882]: warning: SASL authentication failure: Password verification failed
Aug 20 21:20:41 LazerNet-Hosting postfix/smtpd[15882]: warning: c-67-188-22-253.hsd1.ca.comcast.net[67.188.22.253]: SASL PLAIN authentication failed: generic failure
Aug 20 21:20:41 LazerNet-Hosting postfix/smtpd[15882]: lost connection after AUTH from c-67-188-22-253.hsd1.ca.comcast.net[67.188.22.253]
Aug 20 21:20:41 LazerNet-Hosting postfix/smtpd[15882]: disconnect from c-67-188-22-253.hsd1.ca.comcast.net[67.188.22.253]
Aug 20 21:21:08 LazerNet-Hosting postfix/qmgr[6570]: 4A0B48121DD: from=<fchavez@lazernetwork.com>, size=1982, nrcpt=1 (queue active)
Aug 20 21:21:08 LazerNet-Hosting postfix/smtp[15887]: 4A0B48121DD: host f.mx.mail.yahoo.com[209.191.88.247] refused to talk to me: 553 Mail from 67.188.22.253 not allowed - 5.7.1 [BL21] Connections not accepted from IP addresses on Spamhaus PBL; see http://postmaster.yahoo.com/550-bl21.html [550]
Aug 20 21:21:09 LazerNet-Hosting postfix/smtp[15887]: 4A0B48121DD: host c.mx.mail.yahoo.com[216.39.53.3] refused to talk to me: 553 Mail from 67.188.22.253 not allowed - 5.7.1 [BL21] Connections not accepted from IP addresses on Spamhaus PBL; see http://postmaster.yahoo.com/550-bl21.html [550]
Aug 20 21:21:09 LazerNet-Hosting postfix/smtp[15887]: 4A0B48121DD: host c.mx.mail.yahoo.com[216.39.53.2] refused to talk to me: 553 Mail from 67.188.22.253 not allowed - 5.7.1 [BL21] Connections not accepted from IP addresses on Spamhaus PBL; see http://postmaster.yahoo.com/550-bl21.html [550]
Aug 20 21:21:09 LazerNet-Hosting postfix/smtp[15887]: 4A0B48121DD: host g.mx.mail.yahoo.com[206.190.53.191] refused to talk to me: 553 Mail from 67.188.22.253 not allowed - 5.7.1 [BL21] Connections not accepted from IP addresses on Spamhaus PBL; see http://postmaster.yahoo.com/550-bl21.html [550]
Aug 20 21:24:01 LazerNet-Hosting postfix/anvil[15884]: statistics: max connection rate 2/60s for (smtp:67.188.22.253) at Aug 20 21:20:41
Aug 20 21:24:01 LazerNet-Hosting postfix/anvil[15884]: statistics: max connection count 1 for (smtp:67.188.22.253) at Aug 20 21:20:37
Aug 20 21:24:01 LazerNet-Hosting postfix/anvil[15884]: statistics: max cache size 1 at Aug 20 21:20:37
Aug 20 21:24:54 LazerNet-Hosting dovecot: IMAP(fchavez): Connection closed
Aug 20 21:25:13 LazerNet-Hosting dovecot: imap-login: Disconnected: rip=192.168.1.6, lip=192.168.1.6, secured
Aug 20 21:25:13 LazerNet-Hosting dovecot: imap-login: Disconnected: rip=192.168.1.6, lip=192.168.1.6, secured
Aug 20 21:26:18 LazerNet-Hosting postfix/smtp[15887]: 4A0B48121DD: to=<confucioussae@yahoo.com>, relay=b.mx.mail.yahoo.com[66.196.97.250]:25, delay=3234, delays=2923/0.01/311/0, dsn=4.4.2, status=deferred (conversation with b.mx.mail.yahoo.com[66.196.97.250] timed out while receiving the initial server greeting)[/code:1]

I can see that it says permissions denied. how do i fix that?

thanks for the help

Wed, 08/20/2008 - 19:32 (Reply to #3)
andreychek

You may need to tweak the permissions on the /var/spool/postfix/var/run/saslauthd directory.

Mine look like this:

ls -ld /var/spool/postfix/var/run/saslauthd
drwxr-xr-x 2 root sasl 4096 Aug 8 19:10 /var/spool/postfix/var/run/saslauthd

Wed, 08/20/2008 - 20:15
fchavez

I tried Changing the permissions and i still cant send mail from my client.

here is the mail log.

[code:1]
Aug 20 22:11:15 LazerNet-Hosting postfix/smtpd[17982]: lost connection after AUTH from c-67-188-22-253.hsd1.ca.comcast.net[67.188.22.253]
Aug 20 22:11:15 LazerNet-Hosting postfix/smtpd[17982]: disconnect from c-67-188-22-253.hsd1.ca.comcast.net[67.188.22.253]
Aug 20 22:13:37 LazerNet-Hosting postfix/smtpd[18189]: connect from c-67-188-22-253.hsd1.ca.comcast.net[67.188.22.253]
Aug 20 22:13:37 LazerNet-Hosting postfix/smtpd[18189]: warning: SASL authentication failure: cannot connect to saslauthd server: Permission denied
Aug 20 22:13:37 LazerNet-Hosting postfix/smtpd[18189]: warning: SASL authentication failure: Password verification failed
Aug 20 22:13:37 LazerNet-Hosting postfix/smtpd[18189]: warning: c-67-188-22-253.hsd1.ca.comcast.net[67.188.22.253]: SASL PLAIN authentication failed: generic failure
Aug 20 22:13:37 LazerNet-Hosting postfix/smtpd[18189]: lost connection after AUTH from c-67-188-22-253.hsd1.ca.comcast.net[67.188.22.253]
Aug 20 22:13:37 LazerNet-Hosting postfix/smtpd[18189]: disconnect from c-67-188-22-253.hsd1.ca.comcast.net[67.188.22.253]
Aug 20 22:13:45 LazerNet-Hosting postfix/smtpd[18189]: connect from c-67-188-22-253.hsd1.ca.comcast.net[67.188.22.253]
Aug 20 22:13:45 LazerNet-Hosting postfix/smtpd[18189]: warning: SASL authentication failure: cannot connect to saslauthd server: Permission denied
Aug 20 22:13:45 LazerNet-Hosting postfix/smtpd[18189]: warning: SASL authentication failure: Password verification failed
Aug 20 22:13:45 LazerNet-Hosting postfix/smtpd[18189]: warning: c-67-188-22-253.hsd1.ca.comcast.net[67.188.22.253]: SASL PLAIN authentication failed: generic failure
Aug 20 22:13:45 LazerNet-Hosting postfix/smtpd[18189]: lost connection after AUTH from c-67-188-22-253.hsd1.ca.comcast.net[67.188.22.253]
Aug 20 22:13:45 LazerNet-Hosting postfix/smtpd[18189]: disconnect from c-67-188-22-253.hsd1.ca.comcast.net[67.188.22.253]
Aug 20 22:13:49 LazerNet-Hosting postfix/smtpd[18189]: connect from c-67-188-22-253.hsd1.ca.comcast.net[67.188.22.253]
Aug 20 22:13:49 LazerNet-Hosting postfix/smtpd[18189]: warning: SASL authentication failure: cannot connect to saslauthd server: Permission denied
Aug 20 22:13:49 LazerNet-Hosting postfix/smtpd[18189]: warning: SASL authentication failure: Password verification failed
Aug 20 22:13:49 LazerNet-Hosting postfix/smtpd[18189]: warning: c-67-188-22-253.hsd1.ca.comcast.net[67.188.22.253]: SASL PLAIN authentication failed: generic failure
Aug 20 22:13:49 LazerNet-Hosting postfix/smtpd[18189]: lost connection after AUTH from c-67-188-22-253.hsd1.ca.comcast.net[67.188.22.253]
Aug 20 22:13:49 LazerNet-Hosting postfix/smtpd[18189]: disconnect from c-67-188-22-253.hsd1.ca.comcast.net[67.188.22.253][/code:1]

Sun, 06/07/2009 - 07:28
fchavez

I fixed it. Thanks for your help. If anyone else is experiencing this problem i did this to fix it along with the permissions change to 775.

1. postfix does a chroot so it canâ

Topic locked