Random issues when recieving emails (451 Requested action aborted)

Locked
bwestpha
Posts: 5
Joined: Mon 4. May 2020, 13:06

Random issues when recieving emails (451 Requested action aborted)

Post by bwestpha »

Hi there,

im running a Keyhelp server with 20.1.3 installed.
I can not 100% say that this error is already in place since prior version, but since a couple of weeks I got a message from one on my 'clients' (aka friends I'm hosting the page for) that they have problems recieving messages from GMX (german internet provider you may know).

The sender got the following error when trying to send to an email address hosted on my server:

Code: Select all

Von: Systemadministrator
Gesendet: Montag, 7. Dezember 2020 12:16
An: ORIGINAL SENDER
Betreff: Unzustellbar: Silvesterorgelkonzert


Ihre Nachricht hat einige oder alle Empfänger nicht erreicht.

      Betreff:  Some topic

      Gesendet am:      07.12.2020 12:16

Folgende(r) Empfänger kann/können nicht erreicht werden:

      'Firstn Lastn (info@my_hosted_domain.de)' am 07.12.2020 12:16

            Serverfehler: "451 Requested action aborted: local error in processing"'

...
mentionable details:

- I tried to send a mail from my own GMX postbox to that address multiple times, no error
- I tried to find the mail in the logs anywhere, (not found, but maybe I havent looked to the right places or the right way)
- The mail above was sent to an forwarder list ,... so ORIGINAL SENDER --> we-all@some-thirdparty-domain.de --> multiple recipients (also my info@my_hosted_domain.de)

Anybody a clue what is going on here?
The GMX support was not very helpfull but it's not from their mailer-daemon so I guess it's a problem on my side.
User avatar
Florian
Keyweb AG
Posts: 1243
Joined: Wed 20. Jan 2016, 02:28

Re: Random issues when recieving emails (451 Requested action aborted)

Post by Florian »

Hello,

when it is an forwarding list the problem can occur at one of the reciepient server. It is not sure that the problem is your server. The only helpful place is the maillog of your server.
Mit freundlichen Grüßen / Best regards
Florian Cheno

**************************************************************
Keyweb AG - Die Hosting Marke
Neuwerkstr. 45/46, 99084 Erfurt / Germany
http://www.keyweb.de - http://www.keyhelp.de
**************************************************************
bwestpha
Posts: 5
Joined: Mon 4. May 2020, 13:06

Re: Random issues when recieving emails (451 Requested action aborted)

Post by bwestpha »

Florian wrote: Mon 7. Dec 2020, 14:28 Hello,

when it is an forwarding list the problem can occur at one of the reciepient server. It is not sure that the problem is your server. The only helpful place is the maillog of your server.


You are totally right @Florian.
I search some logs, but -to be honest - looked up the wrong ones :S

Code: Select all

Dec  7 12:15:45 eins postfix/anvil[31236]: statistics: max connection count 1 for (smtp:5.188.206.202) at Dec  7 12:05:45
Dec  7 12:15:45 eins postfix/anvil[31236]: statistics: max cache size 3 at Dec  7 12:06:34
Dec  7 12:16:22 eins postfix/smtpd[31984]: connect from xxxxx.kasserver.com[85.00.000.75]
Dec  7 12:16:22 eins policyd-spf[31987]: prepend Received-SPF: Fail (mailfrom) identity=mailfrom; client-ip=85.00.000.75; helo=xxxxx.kasserver.com; envelope-from=ORIGINAL SENDER@gmx.de; receiver=<UNKNOWN>
Dec  7 12:16:22 eins postfix/smtpd[31984]: 67516CC331E: client=xxxxx.kasserver.com[85.00.000.75]
Dec  7 12:16:22 eins postfix/cleanup[31988]: 67516CC331E: message-id=<001f01d6cc8a$6494b9f0$2dbe2dd0$@gmx.de>
Dec  7 12:16:22 eins opendkim[731]: 67516CC331E: s=badeba3b8450 d=gmx.net a=rsa-sha256 SSL
Dec  7 12:16:22 eins postfix/qmgr[2583]: 67516CC331E: from=<ORIGINAL SENDER@gmx.de>, size=7467, nrcpt=1 (queue active)
Dec  7 12:16:22 eins postfix/smtpd[31984]: disconnect from xxxxx.kasserver.com[85.00.000.75] ehlo=2 starttls=1 mail=1 rcpt=1 data=1 quit=1 commands=7
Dec  7 12:16:23 eins postfix/smtpd[31993]: connect from localhost[127.0.0.1]
Dec  7 12:16:23 eins postfix/smtpd[31993]: 2B3BCCC3335: client=localhost[127.0.0.1]
Dec  7 12:16:23 eins postfix/cleanup[31988]: 2B3BCCC3335: message-id=<001f01d6cc8a$6494b9f0$2dbe2dd0$@gmx.de>
Dec  7 12:16:23 eins postfix/smtpd[31993]: disconnect from localhost[127.0.0.1] ehlo=1 mail=1 rcpt=1 data=1 quit=1 commands=5
Dec  7 12:16:23 eins postfix/qmgr[2583]: 2B3BCCC3335: from=<ORIGINAL SENDER@gmx.de>, size=8141, nrcpt=1 (queue active)
Dec  7 12:16:23 eins amavis[26876]: (26876-14) Passed CLEAN {RelayedOpenRelay}, [85.00.000.75]:54596 [37.4.250.85] <ORIGINAL SENDER@gmx.de> -> <info@my_hosted_domain.de>, Queue-ID: 67516CC331E, Message-ID: <001f01d6cc8a$6494b9f0$2dbe2dd0$@gmx.de>, mail_id: YNLpETudpKpt, Hits: 0.739, size: 7639, queued_as: 2B3BCCC3335, 663 ms
Dec  7 12:16:23 eins postfix/smtp[31989]: 67516CC331E: to=<info@my_hosted_domain.de>, relay=127.0.0.1[127.0.0.1]:10024, delay=0.95, delays=0.27/0.01/0/0.66, dsn=2.0.0, status=sent (250 2.0.0 from MTA(smtp:[127.0.0.1]:10025): 250 2.0.0 Ok: queued as 2B3BCCC3335)
Dec  7 12:16:23 eins postfix/qmgr[2583]: 67516CC331E: removed
Dec  7 12:16:23 eins dovecot: lmtp(31747): Connect from local
Dec  7 12:16:23 eins dovecot: lmtp(info@my_hosted_domain.de)<31747><PAKUCwcPzl8DfAAAuK2lug>: msgid=<001f01d6cc8a$6494b9f0$2dbe2dd0$@gmx.de>: saved mail to INBOX
Dec  7 12:16:23 eins dovecot: lmtp(31747): Disconnect from local: Client has quit the connection (state=READY)
Dec  7 12:16:23 eins postfix/lmtp[31994]: 2B3BCCC3335: to=<info@my_hosted_domain.de>, relay=sld.my_public_hostname.de[private/dovecot-lmtp], delay=0.03, delays=0.01/0.01/0/0.01, dsn=2.0.0, status=sent (250 2.0.0 <info@my_hosted_domain.de> PAKUCwcPzl8DfAAAuK2lug Saved)
Dec  7 12:16:23 eins postfix/qmgr[2583]: 2B3BCCC3335: removed
Dec  7 12:16:40 eins postfix/smtpd[31984]: connect from xxxxx.kasserver.com[85.00.000.75]
Dec  7 12:16:40 eins policyd-spf[31987]: prepend Received-SPF: Fail (mailfrom) identity=mailfrom; client-ip=85.00.000.75; helo=xxxxx.kasserver.com; envelope-from=beate.herbert@konzertagentur.de; receiver=<UNKNOWN>
Dec  7 12:16:40 eins postfix/smtpd[31984]: C1C91CC3335: client=xxxxx.kasserver.com[85.00.000.75]
Dec  7 12:16:40 eins postfix/cleanup[31988]: C1C91CC3335: message-id=<8145FFC7-79F2-4B51-AFFA-5A68FF3AF92C@konzertagentur.de>
Dec  7 12:16:40 eins postfix/qmgr[2583]: C1C91CC3335: from=<beate.herbert@konzertagentur.de>, size=30309, nrcpt=1 (queue active)
Dec  7 12:16:40 eins postfix/smtpd[31984]: disconnect from xxxxx.kasserver.com[85.00.000.75] ehlo=2 starttls=1 mail=1 rcpt=1 data=1 quit=1 commands=7
Dec  7 12:16:42 eins postfix/smtpd[31993]: connect from localhost[127.0.0.1]
Dec  7 12:16:42 eins postfix/smtpd[31993]: 05A04CC3342: client=localhost[127.0.0.1]
Dec  7 12:16:42 eins postfix/cleanup[31988]: 05A04CC3342: message-id=<8145FFC7-79F2-4B51-AFFA-5A68FF3AF92C@konzertagentur.de>
Dec  7 12:16:42 eins postfix/smtpd[31993]: disconnect from localhost[127.0.0.1] ehlo=1 mail=1 rcpt=1 data=1 quit=1 commands=5
Dec  7 12:16:42 eins postfix/qmgr[2583]: 05A04CC3342: from=<beate.herbert@konzertagentur.de>, size=30792, nrcpt=1 (queue active)
Dec  7 12:16:42 eins dovecot: lmtp(31747): Connect from local
So I found the matching error log - looks like some SPF issue correct ...
Any suggestions how I can fix this? As far as I know i have configured SPF correctly (or lets say, keyhelp configured 99% of it hopefully correctly :D ).

If there is no easy way to handle this, is there anything else I can do, like deactivating SPF checking (robust - over updates of keyhelp )? (seems like this stuff is really messy and is avoided by a lot of people since it causes many issues *)



Thanks in advance
ben

(to be honest - my naive mind would suggest to get this SPF into the Spam score, but not avoiding the message at all)

* my google research
Locked