mailcow-dockerized
mailcow-dockerized copied to clipboard
Published
20 hours ago •
mailcow
mailcow
BCC-Maps IN and OUT not working on the same time
Contribution guidelines
- [X] I've read the contribution guidelines and wholeheartedly agree
I've found a bug and checked that ...
- [X] ... I understand that not following the below instructions will result in immediate closure and/or deletion of my issue.
- [X] ... I have understood that this bug report is dedicated for bugs, and not for support-related inquiries.
- [X] ... I have understood that answers are voluntary and community-driven, and not commercial support.
- [X] ... I have verified that my issue has not been already answered in the past. I also checked previous issues.
Description
mailbox [email protected] bcc-map: in @domain.tld -> [email protected] out @domain.tld ->[email protected]
sender: [email protected] receiver: [email protected]
- mail is send to [email protected]
- mail is not send to [email protected]
- mail is send to [email protected]
Sending mail from [email protected] to [email protected] will send bcc to [email protected] and other way it will send to [email protected]. But IN and OUT on the same time, don´t work.
Logs
mailcowdockerized-postfix-mailcow-1 | Jul 11 20:54:00 cad3e5d79208 postfix/submission/smtpd[25310]: connect from xxx[xxx]
mailcowdockerized-postfix-mailcow-1 | Jul 11 20:54:00 cad3e5d79208 postfix/submission/smtpd[25310]: Anonymous TLS connection established from xxx[xxx] to smtp.host.tld: TLSv1.2 with cipher ECDHE-RSA-AES256-GCM-SHA384 (256/256 bits)
mailcowdockerized-postfix-mailcow-1 | Jul 11 20:54:01 cad3e5d79208 postfix/submission/smtpd[25310]: 1F058A4DF1: client=xxx[xxx], sasl_method=PLAIN, [email protected]
mailcowdockerized-postfix-mailcow-1 | Jul 11 20:54:06 cad3e5d79208 postfix/cleanup[25314]: 1F058A4DF1: replace: header Received: from [10.200.1.11] (xxx [xxx])??(using TLSv1.2 with cipher ECDHE-RSA-AES256-GCM-SHA384 (256/256 bits))??(No client certificate requested)??(Authenticat from xxx[xxx]; from=<[email protected]> to=<[email protected]> proto=ESMTP helo=<[10.200.1.11]>: Received: from [127.0.0.1] (localhost [127.0.0.1]) by localhost (Mailerdaemon) with ESMTPSA id 1F058A4DF1;??Mon, 11 Jul 2022 20:54:00 +0200 (CEST)
mailcowdockerized-postfix-mailcow-1 | Jul 11 20:54:06 cad3e5d79208 postfix/cleanup[25314]: 1F058A4DF1: message-id=<[email protected]>
mailcowdockerized-postfix-mailcow-1 | Jul 11 20:54:11 cad3e5d79208 postfix/bcc/smtpd[25315]: connect from mailcowdockerized-rspamd-mailcow-1.mailcowdockerized_mailcow-network[172.22.1.13]
mailcowdockerized-postfix-mailcow-1 | Jul 11 20:54:11 cad3e5d79208 postfix/bcc/smtpd[25316]: connect from mailcowdockerized-rspamd-mailcow-1.mailcowdockerized_mailcow-network[172.22.1.13]
mailcowdockerized-postfix-mailcow-1 | Jul 11 20:54:13 cad3e5d79208 postfix/bcc/smtpd[25315]: 353BBA4F11: client=mailcowdockerized-rspamd-mailcow-1.mailcowdockerized_mailcow-network[172.22.1.13]
mailcowdockerized-postfix-mailcow-1 | Jul 11 20:54:13 cad3e5d79208 postfix/cleanup[25317]: 353BBA4F11: message-id=<[email protected]>
mailcowdockerized-postfix-mailcow-1 | Jul 11 20:54:13 cad3e5d79208 postfix/bcc/smtpd[25316]: 37CAFA4F12: client=mailcowdockerized-rspamd-mailcow-1.mailcowdockerized_mailcow-network[172.22.1.13]
mailcowdockerized-postfix-mailcow-1 | Jul 11 20:54:13 cad3e5d79208 postfix/qmgr[348]: 353BBA4F11: from=<[email protected]>, size=1834, nrcpt=1 (queue active)
mailcowdockerized-postfix-mailcow-1 | Jul 11 20:54:13 cad3e5d79208 postfix/bcc/smtpd[25315]: disconnect from mailcowdockerized-rspamd-mailcow-1.mailcowdockerized_mailcow-network[172.22.1.13] helo=1 mail=1 rcpt=1 data=1 quit=1 commands=5
mailcowdockerized-postfix-mailcow-1 | Jul 11 20:54:13 cad3e5d79208 postfix/cleanup[25318]: 37CAFA4F12: message-id=<[email protected]>
mailcowdockerized-postfix-mailcow-1 | Jul 11 20:54:13 cad3e5d79208 postfix/qmgr[348]: 37CAFA4F12: from=<[email protected]>, size=1833, nrcpt=1 (queue active)
mailcowdockerized-postfix-mailcow-1 | Jul 11 20:54:13 cad3e5d79208 postfix/bcc/smtpd[25316]: disconnect from mailcowdockerized-rspamd-mailcow-1.mailcowdockerized_mailcow-network[172.22.1.13] helo=1 mail=1 rcpt=1 data=1 quit=1 commands=5
mailcowdockerized-postfix-mailcow-1 | Jul 11 20:54:13 cad3e5d79208 postfix/lmtp[25319]: 353BBA4F11: to=<[email protected]>, orig_to=<[email protected]>, relay=dovecot[xxx]:24, delay=1.7, delays=1.6/0.02/0/0.05, dsn=2.0.0, status=sent (250 2.0.0 <[email protected]> sCLTDtVxzGIDgQgAVWC8bA Saved)
mailcowdockerized-postfix-mailcow-1 | Jul 11 20:54:13 cad3e5d79208 postfix/qmgr[348]: 353BBA4F11: removed
mailcowdockerized-postfix-mailcow-1 | Jul 11 20:54:13 cad3e5d79208 postfix/lmtp[25320]: 37CAFA4F12: to=<[email protected]>, orig_to=<[email protected]>, relay=dovecot[xxx]:24, delay=1.7, delays=1.6/0.02/0.04/0.01, dsn=2.0.0, status=sent (250 2.0.0 <[email protected]> NvGiEdVxzGIqgQgAVWC8bA Saved)
mailcowdockerized-postfix-mailcow-1 | Jul 11 20:54:13 cad3e5d79208 postfix/qmgr[348]: 37CAFA4F12: removed
mailcowdockerized-postfix-mailcow-1 | Jul 11 20:54:13 cad3e5d79208 postfix/qmgr[348]: 1F058A4DF1: from=<[email protected]>, size=1752, nrcpt=2 (queue active)
mailcowdockerized-postfix-mailcow-1 | Jul 11 20:54:13 cad3e5d79208 postfix/submission/smtpd[25310]: disconnect from xxx[xxx] ehlo=2 starttls=1 auth=1 mail=1 rcpt=2 data=1 quit=1 commands=9
mailcowdockerized-postfix-mailcow-1 | Jul 11 20:54:13 cad3e5d79208 postfix/lmtp[25319]: 1F058A4DF1: to=<[email protected]>, relay=dovecot[xxx]:24, delay=13, delays=13/0.01/0.01/0.05, dsn=2.0.0, status=sent (250 2.0.0 <[email protected]> kAD1FdVxzGIqgQgAVWC8bA Saved)
mailcowdockerized-postfix-mailcow-1 | Jul 11 20:54:13 cad3e5d79208 postfix/smtp[25321]: Trusted TLS connection established to mail.testserver.tld[xxx]:25: TLSv1.2 with cipher ECDHE-RSA-AES256-GCM-SHA384 (256/256 bits)
mailcowdockerized-postfix-mailcow-1 | Jul 11 20:54:13 cad3e5d79208 postfix/smtp[25321]: 1F058A4DF1: to=<[email protected]>, relay=mail.testserver.tld[xxx]:25, delay=13, delays=13/0.06/0.14/0.38, dsn=2.0.0, status=sent (250 OK id=1oAyXt-001IUv-M8)
mailcowdockerized-postfix-mailcow-1 | Jul 11 20:54:13 cad3e5d79208 postfix/qmgr[348]: 1F058A4DF1: removed
mailcowdockerized-postfix-mailcow-1 | Jul 11 20:57:33 cad3e5d79208 postfix/anvil[25312]: statistics: max connection rate 1/60s for (submission:xxx) at Jul 11 20:54:00
mailcowdockerized-postfix-mailcow-1 | Jul 11 20:57:33 cad3e5d79208 postfix/anvil[25312]: statistics: max connection count 1 for (submission:xxx) at Jul 11 20:54:00
mailcowdockerized-postfix-mailcow-1 | Jul 11 20:57:33 cad3e5d79208 postfix/anvil[25312]: statistics: max cache size 1 at Jul 11 20:54:00
mailcowdockerized-dovecot-mailcow-1 | Jul 11 20:54:13 6d925c0097ee dovecot: lmtp(557315): Connect from fd4d:6169:6c63:6f77::e
mailcowdockerized-dovecot-mailcow-1 | Jul 11 20:54:13 6d925c0097ee dovecot: lmtp(557354): Connect from fd4d:6169:6c63:6f77::e
mailcowdockerized-dovecot-mailcow-1 | Jul 11 20:54:13 6d925c0097ee dovecot: lmtp([email protected])<557315><sCLTDtVxzGIDgQgAVWC8bA>: sieve: msgid=<[email protected]>: stored mail into mailbox 'INBOX'
mailcowdockerized-dovecot-mailcow-1 | Jul 11 20:54:13 6d925c0097ee dovecot: lmtp(557315): Disconnect from fd4d:6169:6c63:6f77::e: Logged out (state=READY)
mailcowdockerized-dovecot-mailcow-1 | Jul 11 20:54:13 6d925c0097ee dovecot: lmtp([email protected])<557354><NvGiEdVxzGIqgQgAVWC8bA>: sieve: msgid=<[email protected]>: discard action: Marked message to be discarded if not explicitly delivered (discard action)
mailcowdockerized-dovecot-mailcow-1 | Jul 11 20:54:13 6d925c0097ee dovecot: lmtp(557354): Disconnect from fd4d:6169:6c63:6f77::e: Logged out (state=READY)
mailcowdockerized-dovecot-mailcow-1 | Jul 11 20:54:13 6d925c0097ee dovecot: lmtp(557354): Connect from fd4d:6169:6c63:6f77::e
mailcowdockerized-dovecot-mailcow-1 | Jul 11 20:54:13 6d925c0097ee dovecot: lmtp([email protected])<557354><kAD1FdVxzGIqgQgAVWC8bA>: sieve: msgid=<[email protected]>: stored mail into mailbox 'INBOX'
mailcowdockerized-dovecot-mailcow-1 | Jul 11 20:54:13 6d925c0097ee dovecot: lmtp(557354): Disconnect from fd4d:6169:6c63:6f77::e: Logged out (state=READY)
Steps to reproduce
create mailbox [email protected] create alias [email protected] for archiv create alias [email protected] for archiv
create mailbox for test like [email protected] create bcc map in for @domain.tld bcc to [email protected] out for @domain.tld bcc to [email protected]
send mail from [email protected] to [email protected]; [email protected]
System information
| Question | Answer |
|---|---|
| My operating system | Debain |
| Is Apparmor, SELinux or similar active? | No |
| Virtualization technology (KVM, VMware, Xen, etc - LXC and OpenVZ are not supported | KVM |
| Server/VM specifications (Memory, CPU Cores) | 4C/8GB |
Docker version (docker version) |
20.10.17, build 100c701 |
docker-compose version (docker-compose version) |
v2.6.0 |
mailcow version (git describe --tags `git rev-list --tags --max-count=1` ) |
2022-06b |
| Reverse proxy (custom solution) | No |
Can you post logs of docker-compose logs --tail=1 -f php-fpm-mailcow rspamd-mailcow nginx-mailcow after setting level = "info"; in rspamd-mailcow (and restarting it afterwards)?
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:11:39 #37(rspamd_proxy) <0f1e95>; proxy; proxy_accept_socket: accepted milter connection from fd4d:6169:6c63:6f77::e port 45036
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:11:39 #37(rspamd_proxy) <0f1e95>; milter; rspamd_milter_process_command: got connection from xxx.xxx.176.225:40811
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:11:39 #39(normal) <8ad3cf>; task; rspamd_worker_body_handler: accepted connection from 172.22.1.13 port 33030, task ptr: 00007FF0F2C6C0A0
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:11:39 #39(normal) <8ad3cf>; task; rspamd_message_parse: loaded message; id: <[email protected]>; queue-id: <5BA0FA4801>; size: 1529; checksum: <b7be84e90d40654a4a9d23e0c83f4e95>
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:11:39 #39(normal) <h5k46t>; lua; lua_redis.lua:574: use default Redis settings for dyn_rl
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:11:39 #39(normal) <h5k46t>; lua; rspamd.local.lua:445: dynamic ratelimit request for user [email protected] returned invalid or empty data ("") or error ("nil") - trying dynamic ratelimit for domain...
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:11:39 #39(normal) <h5k46t>; lua; rspamd.local.lua:449: dynamic ratelimit request for domain domain.tld returned invalid or empty data ("") or error ("nil")
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:11:39 #39(normal) <8ad3cf>; lua; greylist.lua:217: skip greylisting for local networks and/or authorized users
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:11:39 #39(normal) <8ad3cf>; task; dkim_symbol_callback: skip DKIM checks for local networks and authorized users
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:11:39 #39(normal) <8ad3cf>; lua; spf.lua:186: skip SPF checks for local networks and authorized users
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:11:39 #39(normal) <8ad3cf>; lua; dmarc.lua:349: skip DMARC checks as either SPF or DKIM were not checked
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:11:39 #39(normal) <8ad3cf>; lua; lua_dkim_tools.lua:565: using selector prefix 'DKIM_SELECTORS' for domain 'domain.tld'
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:11:39 #39(normal) <8ad3cf>; lua; once_received.lua:99: Skipping once_received for authenticated user or local network
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:11:39 #39(normal) <8ad3cf>; lua; clamav.lua:134: clamav: message or mime_part is clean
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:11:40 #39(normal) <8ad3cf>; task; rspamd_symcache_finalize_item: slow rule: RSPAMD_EMAILBL(327): 816.81 ms; enable slow timer delay
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:11:40 #39(normal) <8ad3cf>; task; rspamd_symcache_finalize_item: slow rule: MSBL_EBL(314): 1048.81 ms; enable slow timer delay
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:11:41 #38(controller) rdns; rdns_parse_rr: unexpected RR type: 46; domain bazaar.abuse.ch
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:11:41 #38(controller) rdns; rdns_parse_rr: unexpected RR type: 46; domain bazaar.abuse.ch
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:11:41 #38(controller) <c6onet>; map; http_map_finish: data is not modified for server bazaar.abuse.ch, next check at Tue, 12 Jul 2022 16:12:11 GMT (timer based)
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:11:42 #39(normal) <8ad3cf>; task; rspamd_symcache_finalize_item: slow rule: DBL(310): 3065.77 ms; enable slow timer delay
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:11:42 #39(normal) <8ad3cf>; task; rspamd_redis_connected: skip obtaining bayes tokens for BAYES_SPAM of classifier bayes: not enough learns 0; 5 required
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:11:42 #39(normal) <8ad3cf>; task; rspamd_redis_connected: skip obtaining bayes tokens for BAYES_HAM of classifier bayes: not enough learns 2; 5 required
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:11:42 #39(normal) <8ad3cf>; task; rspamd_stat_classifiers_process: skip statistics as SPAM class is missing
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:11:42 #39(normal) <8ad3cf>; lua; greylist.lua:331: Score too low - skip greylisting
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:11:42 #39(normal) <h5k46t>; lua; lua_redis.lua:574: use default Redis settings for taghandler
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:11:42 #39(normal) lua; rspamd.local.lua:377: metric action now: no action
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:11:42 #39(normal) <h5k46t>; lua; rspamd.local.lua:397: checking bcc for rcpt address [email protected]
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:11:42 #39(normal) <h5k46t>; lua; rspamd.local.lua:397: checking bcc for rcpt address @domain.tld
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:11:42 #39(normal) <h5k46t>; lua; rspamd.local.lua:410: checking bcc for from address [email protected]
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:11:42 #39(normal) <h5k46t>; lua; rspamd.local.lua:410: checking bcc for from address @domain.tld
mailcowdockerized-nginx-mailcow-1 | 2022/07/12 18:11:42 [error] 22#22: *165 FastCGI sent in stderr: "PHP message: BCC MAP: returning [email protected] for @domain.tld" while reading response header from upstream, client: 172.22.1.13, server: _, request: "GET /bcc.php HTTP/1.1", upstream: "fastcgi://[fd4d:6169:6c63:6f77::c]:9001", host: "nginx"
mailcowdockerized-nginx-mailcow-1 | 2022/07/12 18:11:42 [error] 22#22: *163 FastCGI sent in stderr: "PHP message: BCC MAP: returning [email protected] for @domain.tld" while reading response header from upstream, client: 172.22.1.13, server: _, request: "GET /bcc.php HTTP/1.1", upstream: "fastcgi://[fd4d:6169:6c63:6f77::c]:9001", host: "nginx"
mailcowdockerized-nginx-mailcow-1 | 172.22.1.13 - - [12/Jul/2022:18:11:42 +0200] "GET /bcc.php HTTP/1.1" 201 32 "-" "rspamd-3.2"
mailcowdockerized-nginx-mailcow-1 | 172.22.1.13 - - [12/Jul/2022:18:11:42 +0200] "GET /bcc.php HTTP/1.1" 200 5 "-" "rspamd-3.2"
mailcowdockerized-nginx-mailcow-1 | 172.22.1.13 - - [12/Jul/2022:18:11:42 +0200] "GET /bcc.php HTTP/1.1" 201 31 "-" "rspamd-3.2"
mailcowdockerized-nginx-mailcow-1 | 172.22.1.13 - - [12/Jul/2022:18:11:42 +0200] "GET /bcc.php HTTP/1.1" 200 5 "-" "rspamd-3.2"
mailcowdockerized-php-fpm-mailcow-1 | fd4d:6169:6c63:6f77::f - 12/Jul/2022:18:11:42 +0200 "GET /bcc.php" 201
mailcowdockerized-php-fpm-mailcow-1 | [12-Jul-2022 18:11:42] WARNING: [pool system-worker] child 39 said into stderr: "NOTICE: PHP message: BCC MAP: returning [email protected] for @domain.tld"
mailcowdockerized-php-fpm-mailcow-1 | 172.22.1.10 - 12/Jul/2022:18:11:42 +0200 "GET /bcc.php" 200
mailcowdockerized-php-fpm-mailcow-1 | fd4d:6169:6c63:6f77::f - 12/Jul/2022:18:11:42 +0200 "GET /bcc.php" 201
mailcowdockerized-php-fpm-mailcow-1 | [12-Jul-2022 18:11:42] WARNING: [pool system-worker] child 39 said into stderr: "NOTICE: PHP message: BCC MAP: returning [email protected] for @domain.tld"
mailcowdockerized-php-fpm-mailcow-1 | 172.22.1.10 - 12/Jul/2022:18:11:42 +0200 "GET /bcc.php" 200
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:11:42 #39(normal) <h5k46t>; lua; rspamd.local.lua:337: BCC SMTP SUCCESS TO [email protected]
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:11:42 #39(normal) <h5k46t>; lua; rspamd.local.lua:337: BCC SMTP SUCCESS TO [email protected]
mailcowdockerized-php-fpm-mailcow-1 | [12-Jul-2022 18:11:42] WARNING: [pool system-worker] child 39 said into stderr: "NOTICE: PHP message: RCPT RESOVLER: http pipe: query [email protected] as username from mailbox"
mailcowdockerized-php-fpm-mailcow-1 | [12-Jul-2022 18:11:42] WARNING: [pool system-worker] child 39 said into stderr: "NOTICE: PHP message: RCPT RESOVLER: http pipe: mailbox found: [email protected]"
mailcowdockerized-php-fpm-mailcow-1 | [12-Jul-2022 18:11:42] WARNING: [pool system-worker] child 39 said into stderr: "NOTICE: PHP message: RCPT RESOVLER: http pipe: goto array count on loop #1 is 0"
mailcowdockerized-php-fpm-mailcow-1 | [12-Jul-2022 18:11:42] WARNING: [pool system-worker] child 39 said into stderr: "NOTICE: PHP message: NOTIFY: pushover pipe: processing pushover message for rcpt [email protected]"
mailcowdockerized-php-fpm-mailcow-1 | fd4d:6169:6c63:6f77::f - 12/Jul/2022:18:11:42 +0200 "POST /pushover.php" 200
mailcowdockerized-nginx-mailcow-1 | 2022/07/12 18:11:42 [error] 22#22: *170 FastCGI sent in stderr: "PHP message: RCPT RESOVLER: http pipe: query [email protected] as username from mailbox
mailcowdockerized-nginx-mailcow-1 | PHP message: RCPT RESOVLER: http pipe: mailbox found: [email protected]
mailcowdockerized-nginx-mailcow-1 | PHP message: RCPT RESOVLER: http pipe: goto array count on loop #1 is 0
mailcowdockerized-nginx-mailcow-1 | PHP message: NOTIFY: pushover pipe: processing pushover message for rcpt [email protected]" while reading response header from upstream, client: 172.22.1.13, server: _, request: "POST /pushover.php HTTP/1.1", upstream: "fastcgi://[fd4d:6169:6c63:6f77::c]:9001", host: "nginx"
mailcowdockerized-nginx-mailcow-1 | 172.22.1.13 - - [12/Jul/2022:18:11:42 +0200] "POST /pushover.php HTTP/1.1" 200 5 "-" "rspamd-3.2"
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:11:42 #39(normal) <8ad3cf>; task; rspamd_task_write_log: id: <[email protected]>, qid: <5BA0FA4801>, ip: xxx.xxx.176.225, user: [email protected], from: <[email protected]>, (default: F (no action): [-20.00/15.00] [MAILCOW_AUTH(-20.00){},FISHY_TLD(0.10){domain.tld;},MIME_GOOD(-0.10){multipart/alternative;text/plain;},ARC_NA(0.00){},ASN(0.00){asn:6830, ipnet:xxx.xxx.176.0/22, country:XX;},BCC(0.00){},DKIM_SIGNED(0.00){domain.tld:s=dkim;},DYN_RL_CHECK(0.00){},FROM_EQ_ENVFROM(0.00){},FROM_HAS_DN(0.00){},HAS_REPLYTO(0.00){[email protected];},MAILCOW_DOMAIN_HEADER_FROM(0.00){domain.tld;},MIME_TRACE(0.00){0:+;1:+;2:~;},RCPT_COUNT_ONE(0.00){1;},RCPT_MAILCOW_DOMAIN(0.00){domain.tld;},RCVD_COUNT_ZERO(0.00){0;},REPLYTO_EQ_FROM(0.00){},TO_DN_ALL(0.00){},TO_EQ_FROM(0.00){},TO_MATCH_ENVRCPT_ALL(0.00){}]), len: 1529, time: 3252.167ms, dns req: 10, digest: <b7be84e90d40654a4a9d23e0c83f4e95>, rcpts: <[email protected]>, mime_rcpts: <[email protected]>
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:11:42 #39(normal) <8ad3cf>; task; rspamd_protocol_http_reply: regexp statistics: 0 pcre regexps scanned, 3 regexps matched, 3246 regexps total, 2996 regexps cached, 0B scanned using pcre, 1.51KiB scanned total
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:11:42 #37(rspamd_proxy) <7b72e2>; proxy; proxy_milter_finish_handler: finished milter connection
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:11:48 #38(controller) <rznbhc>; map; rspamd_map_cache_cb: cached data is now expired (gen mismatch 9 != 10) for http://nginx:8081/forwardinghosts.php; shm name=/rhm.d67a367f08afec5fc78f; refcount=1
mailcowdockerized-nginx-mailcow-1 | 172.22.1.5 - - [12/Jul/2022:18:11:50 +0200] "GET / HTTP/1.1" 200 15 "-" "check_http/v (nagios-plugins 2.3.3)"
mailcowdockerized-php-fpm-mailcow-1 | 172.22.1.10 - 12/Jul/2022:18:12:03 +0200 "HEAD /forwardinghosts.php" 200
mailcowdockerized-nginx-mailcow-1 | 172.22.1.13 - - [12/Jul/2022:18:12:03 +0200] "HEAD /forwardinghosts.php HTTP/1.1" 200 0 "-" "rspamd-3.2"
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:12:03 #38(controller) <rznbhc>; map; http_map_finish: need to reread map from http://nginx:8081/forwardinghosts.php
mailcowdockerized-nginx-mailcow-1 | 172.22.1.13 - - [12/Jul/2022:18:12:03 +0200] "GET /forwardinghosts.php HTTP/1.1" 200 27 "-" "rspamd-3.2"
mailcowdockerized-php-fpm-mailcow-1 | fd4d:6169:6c63:6f77::f - 12/Jul/2022:18:12:03 +0200 "GET /forwardinghosts.php" 200
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:12:03 #38(controller) <rznbhc>; map; http_map_finish: stored map data in a shared memory cache: /rhm.2a97515739c60c8a4b32
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:12:03 #38(controller) <rznbhc>; map; http_map_finish: http://nginx:8081/forwardinghosts.php(172.22.1.10:8081): read map data 32 bytes, next check at Tue, 12 Jul 2022 16:12:33 GMT
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:12:03 #38(controller) <rznbhc>; map; rspamd_map_save_http_cached_file: saved data from http://nginx:8081/forwardinghosts.php in /var/lib/rspamd/e48ac0193da10600fac6a17bb7146ba2421fee67.map, 56 bytes
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:12:03 #38(controller) <rznbhc>; map; rspamd_radix_fin: read radix trie of 1 elements: ents=1 dup=0 tbm=0 lc=3 mem=1k free=0 waste=0
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:12:04 #38(controller) <4cdbeb>; csession; rspamd_controller_check_password: allow unauthorized connection from a unix socket
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:12:04 #38(controller) <4cdbeb>; csession; rspamd_mime_parse_message: cannot find content-type for a message, assume text/plain
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:12:04 #38(controller) <4cdbeb>; csession; rspamd_mime_part_get_cte: detected missing CTE for part as: 7bit
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:12:04 #38(controller) <4cdbeb>; csession; rspamd_message_parse: loaded message; id: <undef>; queue-id: <undef>; size: 52; checksum: <593fbedc45b4499d86efc2599f6a4002>
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:12:04 #38(controller) <h5k46t>; lua; lua_redis.lua:574: use default Redis settings for dyn_rl
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:12:04 #38(controller) <h5k46t>; lua; lua_redis.lua:574: use default Redis settings for keep_spam
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:12:04 #38(controller) <4cdbeb>; lua; settings.lua:389: <undef> apply settings according to rule watchdog (from_mime,rcpt_mime matched)
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:12:04 #38(controller) <4cdbeb>; csession; rspamd_symcache_disable_symbol_checkpoint: cannot disable ARC: not found
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:12:04 #38(controller) <4cdbeb>; csession; rspamd_symcache_disable_symbol_checkpoint: cannot disable DKIM: not found
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:12:04 #38(controller) <4cdbeb>; csession; rspamd_redis_connected: skip obtaining bayes tokens for BAYES_HAM of classifier bayes: not enough learns 2; 5 required
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:12:04 #38(controller) <4cdbeb>; csession; rspamd_redis_connected: skip obtaining bayes tokens for BAYES_SPAM of classifier bayes: not enough learns 0; 5 required
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:12:04 #38(controller) <4cdbeb>; csession; rspamd_stat_classifiers_process: skip statistics as SPAM class is missing
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:12:04 #38(controller) <h5k46t>; lua; lua_redis.lua:574: use default Redis settings for taghandler
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:12:04 #38(controller) <4cdbeb>; csession; rspamd_protocol_http_reply: regexp statistics: 0 pcre regexps scanned, 0 regexps matched, 3246 regexps total, 2439 regexps cached, 0B scanned using pcre, 102B scanned total
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:12:04 #37(rspamd_proxy) <ba8deb>; proxy; proxy_accept_socket: accepted milter connection from 172.22.1.5 port 37472
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:12:04 #37(rspamd_proxy) <ba8deb>; proxy; proxy_milter_error_handler: abnormally closing milter connection from: 172.22.1.5:37472, error: HTTP GET request is not supported in milter mode, url: /
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:12:07 #39(normal) <rznbhc>; map; rspamd_map_common_http_callback: need to reread cached map triggered by http://nginx:8081/forwardinghosts.php (1657642285 our modify time, 1657642323 cached modify time)
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:12:07 #39(normal) <rznbhc>; map; rspamd_map_read_cached: http://nginx:8081/forwardinghosts.php: read map data cached 32 bytes
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:12:07 #39(normal) <rznbhc>; map; rspamd_radix_fin: read radix trie of 1 elements: ents=1 dup=0 tbm=0 lc=3 mem=1k free=0 waste=0
mailcowdockerized-nginx-mailcow-1 | 172.22.1.13 - - [12/Jul/2022:18:12:12 +0200] "HEAD /settings.php HTTP/1.1" 304 0 "-" "rspamd-3.2"
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:12:12 #38(controller) <oxhd99>; map; http_map_finish: data is not modified for server nginx, next check at Tue, 12 Jul 2022 16:12:42 GMT (timer based)
mailcowdockerized-php-fpm-mailcow-1 | 172.22.1.10 - 12/Jul/2022:18:12:12 +0200 "HEAD /settings.php" 304
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:12:15 #38(controller) rdns; rdns_parse_rr: unexpected RR type: 46; domain nullnull.org
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:12:15 #38(controller) rdns; rdns_parse_rr: unexpected RR type: 46; domain nullnull.org
mailcowdockerized-rspamd-mailcow-1 | 2022-07-12 18:12:15 #38(controller) <q37eyd>; map; http_map_finish: data is not modified for server nullnull.org, next check at Tue, 12 Jul 2022 16:12:45 GMT (timer based)
Well, it works correctly in all cases.
See your sieve logs above:
mailcowdockerized-dovecot-mailcow-1 | Jul 11 20:54:13 6d925c0097ee dovecot: lmtp([email protected])<557354><NvGiEdVxzGIqgQgAVWC8bA>: sieve: msgid=<[email protected]>: discard action: Marked message to be discarded if not explicitly delivered (discard action)
You are dropping it.
This issue has been automatically marked as stale because it has not had recent activity. It will be closed if no further activity occurs.
