Go Back   HowtoForge Forums | HowtoForge - Linux Howtos and Tutorials > ISPConfig 3 > Installation/Configuration

Do you like HowtoForge? Please consider supporting us by becoming a subscriber.
Reply
 
Thread Tools Display Modes
  #1  
Old 27th February 2010, 06:35
aclhkaclhk aclhkaclhk is offline
Junior Member
 
Join Date: Aug 2009
Posts: 29
Thanks: 0
Thanked 0 Times in 0 Posts
Default amavis rejects all inbound emails

i did a fresh install according to
http://www.howtoforge.com/perfect-se...64-ispconfig-3

I created a domain and mailbox with spam policy "uncensored".

All incoming emails are blocked and returned according to /var/log/maillog

I want to have all incoming email received with [spam] tag in the subject without rejection.

I have changed the uncensor policy as below:

- spam dsn: 999 or 0
- spam: quarantine: 999 or 0
- spam subject: yes

pls advise.
Reply With Quote
Sponsored Links
  #2  
Old 27th February 2010, 06:39
aclhkaclhk aclhkaclhk is offline
Junior Member
 
Join Date: Aug 2009
Posts: 29
Thanks: 0
Thanked 0 Times in 0 Posts
Default

below is the email log:

Feb 27 13:37:29 ispconfig3 amavis[5245]: (05245-01) Blocked SPAM, MYNETS LOCAL [192.168.123.238] [192.168.123.238] <a@a.com> -> <123@abc.com>, quarantine: spam-kB1dQ+EgK3NW.gz, Message-ID: <20100227053718.52002130E78@ispconfig3.aclhk.com >, mail_id: kB1dQ+EgK3NW, Hits: 9.54, size: 315, 1913 ms
Feb 27 13:37:29 ispconfig3 postfix/smtp[5257]: 52002130E78: to=<123@abc.com>, relay=127.0.0.1[127.0.0.1]:10024, delay=17, delays=15/0.01/0.01/1.9, dsn=2.5.0, status=sent (250 2.5.0 Ok, id=05245-01, BOUNCE)

it seems that spamassassin was not launched. the email was rejected by amavis.

i do not want amavis to reject email.
Reply With Quote
  #3  
Old 27th February 2010, 10:45
till till is offline
Super Moderator
 
Join Date: Apr 2005
Location: Lüneburg, Germany
Posts: 35,466
Thanks: 813
Thanked 5,253 Times in 4,119 Posts
Default

Quote:
it seems that spamassassin was not launched. the email was rejected by amavis.
amavisd is spamassassin, as amavisd is a daemon that uses the spamassassin libraries.

To your original question, change:

$final_spam_destiny = D_DISCARD;

to:

$final_spam_destiny = D_PASS;

in amavisd.conf or the 50-user file in the amavisd directory (depends on the linux distribution) and restart amavisd.
__________________
Till Brehm
--
Get ISPConfig support and the ISPConfig 3 manual from ispconfig.org.
Reply With Quote
  #4  
Old 28th February 2010, 03:31
aclhkaclhk aclhkaclhk is offline
Junior Member
 
Join Date: Aug 2009
Posts: 29
Thanks: 0
Thanked 0 Times in 0 Posts
Default

thanks, I received all emails but there was no spam header inserted.

I set the spam policy to normal, spam tag=0, modifies subject=yes.
I tried a testing:
sendmail -i 123@abc.com < sample-spam-GTUBE-junk.txt

no X-Spam-Status and X-Spam-Level in header fields.

pls advise
Reply With Quote
  #5  
Old 28th February 2010, 04:18
aclhkaclhk aclhkaclhk is offline
Junior Member
 
Join Date: Aug 2009
Posts: 29
Thanks: 0
Thanked 0 Times in 0 Posts
Default

below is the debug log:
from=<root@ispconfig3.123.com>, size=1170, nrcpt=1 (queue active)
Feb 28 10:53:35 ispconfig3 sendmail[5597]: o1S2rFqD005597: to=123@abc.com, ctladdr=root (0/0), delay=00:00:20, xdelay=00:00:10, mailer=relay, pri=210799, relay=[127.0.0.1] [127.0.0.1], dsn=2.0.0, stat=Sent (Ok: queued as 7DE05130F2A)
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-03-4) Net::Server: 2010/02/28-10:53:35 CONNECT TCP Peer: "127.0.0.1:35914" Local: "127.0.0.1:10024"
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-03-4) idle_proc, hi : was idle, 207790.0 ms, total idle 638.035 s, busy 29.391 s
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-03-4) loaded base policy bank
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-03-4) lookup_ip_acl (inet_acl): key="127.0.0.1" matches "127.0.0.1", result=1
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-03-4) process_request: fileno sock=12, STDIN=0, STDOUT=1
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-03-4) switch_to_my_time 480 s, new request
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-03-4) process_request: suggested_protocol="" on TCP
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) SMTP> 220 [127.0.0.1] ESMTP amavisd-new service ready
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) switch_to_client_time 480 s, smtp response sent
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) idle_proc, 4: was busy, 2.1 ms, total idle 638.035 s, busy 29.393 s
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) idle_proc, 5: was idle, 0.5 ms, total idle 638.035 s, busy 29.393 s
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) SMTP< EHLO ispconfig3.123.com\r\n
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) switch_to_my_time 480 s, SMTP EHLO received
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) ESMTP> 250-[127.0.0.1]
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) ESMTP> 250-VRFY
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) ESMTP> 250-PIPELINING
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) ESMTP> 250-SIZE
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) ESMTP> 250-ENHANCEDSTATUSCODES
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) ESMTP> 250-8BITMIME
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) ESMTP> 250-DSN
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) ESMTP> 250 XFORWARD NAME ADDR PORT PROTO HELO SOURCE
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) switch_to_client_time 480 s, smtp response sent
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) idle_proc, 6: was busy, 1.5 ms, total idle 638.035 s, busy 29.395 s
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) idle_proc, 5: was idle, 0.3 ms, total idle 638.036 s, busy 29.395 s
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) ESMTP< XFORWARD NAME=localhost.localdomain ADDR=127.0.0.1\r\n
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) switch_to_my_time 480 s, SMTP XFORWARD received
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) ESMTP> 250 2.5.0 Ok XFORWARD
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) switch_to_client_time 480 s, smtp response sent
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) idle_proc, 6: was busy, 0.6 ms, total idle 638.036 s, busy 29.395 s
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) idle_proc, 5: was idle, 0.1 ms, total idle 638.036 s, busy 29.395 s
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) ESMTP< XFORWARD PROTO=ESMTP HELO=ispconfig3.123.com SOURCE=LOCAL\r\n
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) switch_to_my_time 480 s, SMTP XFORWARD received
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) ESMTP> 250 2.5.0 Ok XFORWARD
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) switch_to_client_time 480 s, smtp response sent
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) idle_proc, 6: was busy, 0.5 ms, total idle 638.036 s, busy 29.396 s
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) idle_proc, 5: was idle, 0.3 ms, total idle 638.036 s, busy 29.396 s
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) ESMTP< MAIL FROM:<root@ispconfig3.123.com> SIZE=1170\r\n
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) switch_to_my_time 480 s, SMTP MAIL received
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) check_mail_begin_task: task_count=7
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) lookup_ip_acl: key="127.0.0.1" matches "127.0.0.0/8", result=1
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) loaded policy bank "MYNETS"
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) lookup [debug_sender] => undef, "root@ispconfig3.123.com" does not match
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) ESMTP> 250 2.1.0 Sender <root@ispconfig3.123.com> OK
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) switch_to_client_time 480 s, smtp response sent
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) idle_proc, 6: was busy, 1.6 ms, total idle 638.036 s, busy 29.397 s
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) idle_proc, 5: was idle, 0.1 ms, total idle 638.036 s, busy 29.397 s
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) ESMTP< RCPT TO:<123@abc.com> ORCPT=rfc822;123@abc.com\r\n
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) switch_to_my_time 480 s, SMTP RCPT received
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) ESMTP> 250 2.1.5 Recipient <123@abc.com> OK
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) switch_to_client_time 480 s, smtp response sent
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) idle_proc, 6: was busy, 0.9 ms, total idle 638.036 s, busy 29.398 s
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) idle_proc, 5: was idle, 0.1 ms, total idle 638.036 s, busy 29.398 s
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) ESMTP< DATA\r\n
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) switch_to_my_time 480 s, SMTP DATA received
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) ESMTP::10024 /var/amavis/tmp/amavis-20100228T104228-05003: <root@ispconfig3.123.com> -> <123@abc.com> SIZE=1170 Received: from ispconfig3.123.com ([127.0.0.1]) by localhost (ispconfig3.123.com [127.0.0.1]) (amavisd-new, port 10024) with ESMTP for <123@abc.com>; Sun, 28 Feb 2010 10:53:35 +0800 (HKT)
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) ESMTP> 354 End data with <CR><LF>.<CR><LF>
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) switch_to_client_time 480 s, smtp response sent
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) switch_to_client_time 480 s, receiving data
Feb 28 10:53:35 ispconfig3 postfix/smtpd[5598]: disconnect from localhost.localdomain[127.0.0.1]
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) switch_to_my_time 480 s, data-end received
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) ESMTP< .<CR><LF>
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) smtp connection cache, dt: 209.8, state: 1
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) smtp connection cache, dt: 209.8 -> disabling
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) prolong_timer digest_init: timer set to 480 s
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) get_body_digest: reading header section
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) prolong_timer digest_hdr: timer set to 480 s
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) get_body_digest: reading mail body
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) prolong_timer digest_body: timer set to 480 s
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) body type (ESMTP BODY): unlabeled, good (h=0, b=0)
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) body hash: fbfaa7ae2ce107ec1ee6598c72d0e04f
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) Original mail size: 1170; quota set to: 585000 bytes
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) Checking: gTE40LXjoxuo MYNETS [127.0.0.1] <root@ispconfig3.123.com> -> <123@abc.com>
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) 2822.From: <sender@example.net>, 2821.Mail_From: <root@ispconfig3.123.com>
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) lookup_acl(123@abc.com), no match
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) lookup [local_domains] => undef, "123@abc.com" does not match
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) query_keys: 123@abc.com, 123@, abc.com, .abc.com, .com, .
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) lookup_hash(123@abc.com), no matches
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) lookup [bypass_virus_checks] => undef, "123@abc.com" does not match
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) query_keys: 123@abc.com, 123@, abc.com, .abc.com, .com, .
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) lookup_hash(123@abc.com), no matches
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) lookup [bypass_banned_checks] => undef, "123@abc.com" does not match
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) query_keys: 123@abc.com, 123@, abc.com, .abc.com, .com, .
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) lookup_hash(123@abc.com), no matches
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) lookup [bypass_spam_checks] => undef, "123@abc.com" does not match
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) Cached virus check expired, TTL = 180 s
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) cached fbfaa7ae2ce107ec1ee6598c72d0e04f from <root@ispconfig3.123.com> (0,1)
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) cache entry age: S c=20100228T024228 a=20100228T024413
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) Extracting mime components
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) Issued a new file name: p001
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) Charging 505 bytes to remaining quota 585000 (out of 585000, (0%)) - by mime_decode
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) p001 1 Content-Type: text/plain, size: 505 B, name:
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) prolong_timer mime_decode: remaining time = 480 s
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) prolong_timer mime_decode-1: remaining time = 480 s
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) inspect_dsn: parts: text/plain
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) inspect_dsn: not a bounce
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) prolong_timer dsn_parse: remaining time = 480 s
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) decode_parts: level=1, #parts=1 : p001
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) running file(1) on 1 files, arglist size 18
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) run_command: [5608] /usr/bin/file p001 </dev/null 2>&1
Feb 28 10:53:35 ispconfig3 amavis[5608]: (05003-04) open_on_specific_fd: target fd0 closing, to become < /dev/null
Feb 28 10:53:35 ispconfig3 amavis[5608]: (05003-04) open_on_specific_fd: target fd1 closing, to become > &=16
Feb 28 10:53:35 ispconfig3 amavis[5608]: (05003-04) open_on_specific_fd: target fd1 dup2 from fd16 > &=16
Feb 28 10:53:35 ispconfig3 amavis[5608]: (05003-04) open_on_specific_fd: source fd16 closed
Feb 28 10:53:35 ispconfig3 amavis[5608]: (05003-04) open_on_specific_fd: target fd2 closing, to become > &1
Feb 28 10:53:35 ispconfig3 amavis[5608]: (05003-04) open_on_specific_fd: target fd2 dup2 from fd1 > &1
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) result line from file(1): p001: ASCII English text\n
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) lookup_re("ASCII English text") matches key "(?i-xsm:^(ASCII|text)\b)", result="asc"
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) lookup [map_full_type_to_short_type] => true, "ASCII English text" matches, result="asc", matching_key="(?i-xsm:^(ASCII|text)\\b)"
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) File-type of p001: ASCII English text; (asc)
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) do_ascii: Decoding part p001
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) do_ascii: Setting sigaction handler, was 0
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) timer set to 320 s (was 480 s)
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) do_ascii: Decoding part p001 (0 items), uulib V0.5pl20
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) prolong_timer do_ascii: timer set to 480 s
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) decompose_part: p001 - atomic
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) prolong_timer parts_decode: remaining time = 480 s
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) query_keys: 123@abc.com, 123@, abc.com, .abc.com, .com, .
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) lookup_hash(123@abc.com), no matches
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) lookup [bypass_header_checks] => undef, "123@abc.com" does not match
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) check_header: 0, OK
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) query_keys: 123@abc.com, 123@, abc.com, .abc.com, .com, .
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) lookup_hash(123@abc.com), no matches
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) lookup [bypass_header_checks] => undef, "123@abc.com" does not match
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) Checking for banned types and filenames
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) lookup: (scalar) matches, result="DEFAULT"
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) lookup [banned_filename], 1 matches for "123@abc.com", results: "(constantEFAULT)"=>"DEFAULT"
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) collect banned table[0]: 123@abc.com, tables: DEFAULT=>Amavis::Lookup::RE=ARRAY(0xe39b580)
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) starting banned checks - traversing message structure tree
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) check_for_banned (p001) text/plain,.asc
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) doing banned check for 123@abc.com on text/plain,.asc
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) lookup_re(["text/plain",".asc"]), no matches
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) lookup [check_bann:123@abc.com] => undef, ["text/plain",".asc"] does not match
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) lookup [banned_namepath_re] => undef, "P=p001\tL=1\tM=text/plain\tT=asc" does not match
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) p.path 123@abc.com: "P=p001,L=1,M=text/plain,T=asc"
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) banned check: any=0, all=N (1)
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) lookup_re("MAIL") matches key "(?-xism:^MAIL$)", result="1"
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) lookup [keep_decoded_original] => true, "MAIL" matches, result="1", matching_key="(?-xism:^MAIL$)"
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) Issued a new file name: p002
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) presenting full original message to scanners as /var/amavis/tmp/amavis-20100228T104228-05003/parts/p002
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) (!!)WARN: all primary virus scanners failed, considering backups
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) Calling virus scanners, 2 files to scan in /var/amavis/tmp/amavis-20100228T104228-05003/parts
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) run_av (ClamAV-clamscan): query template(0,1): --stdout --no-summary -r --tempdir=/var/amavis/tmp {}
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) prolong_timer run_av: timer set to 480 s
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) prolong_timer run_av: timer set to 384 s
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) run_av Using (ClamAV-clamscan): /usr/bin/clamscan --stdout --no-summary -r --tempdir=/var/amavis/tmp /var/amavis/tmp/amavis-20100228T104228-05003/parts
Feb 28 10:53:35 ispconfig3 amavis[5609]: (05003-04) open_on_specific_fd: target fd0 closing, to become < /dev/null
Feb 28 10:53:35 ispconfig3 amavis[5609]: (05003-04) open_on_specific_fd: target fd1 closing, to become > &=16
Feb 28 10:53:35 ispconfig3 amavis[5609]: (05003-04) open_on_specific_fd: target fd1 dup2 from fd16 > &=16
Feb 28 10:53:35 ispconfig3 amavis[5609]: (05003-04) open_on_specific_fd: source fd16 closed
Feb 28 10:53:35 ispconfig3 amavis[5609]: (05003-04) open_on_specific_fd: target fd2 closing, to become > &1
Feb 28 10:53:35 ispconfig3 amavis[5609]: (05003-04) open_on_specific_fd: target fd2 dup2 from fd1 > &1
Feb 28 10:53:35 ispconfig3 amavis[5003]: (05003-04) run_command: [5609] /usr/bin/clamscan --stdout --no-summary -r --tempdir=/var/amavis/tmp /var/amavis/tmp/amavis-20100228T104228-05003/parts </dev/null 2>&1
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) collect_results from [5609] (ClamAV-clamscan), 120 bytes, (limit 204800)
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) prolong_timer run_av: timer set to 478 s
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) run_av: /usr/bin/clamscan exit 0, /var/amavis/tmp/amavis-20100228T104228-05003/parts/p002: OK\n/var/amavis/tmp/amavis-20100228T104228-05003/parts/p001: OK
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) run_av (ClamAV-clamscan): CLEAN
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) run_av (ClamAV-clamscan) result: clean
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) wbl: checking sender <root@ispconfig3.123.com>, <sender@example.net>
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup [blacklist_recip<123@abc.com>] => undef, "123@abc.com" does not match
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) query_keys: root@ispconfig3.123.com, root@, ispconfig3.123.com, .ispconfig3.123.com, .123.com, .com, .
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup_hash(root@ispconfig3.123.com), no matches
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup [blacklist_sender<root@ispconfig3.123.com>,blacklis t_sender] => undef, "root@ispconfig3.123.com" does not match
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup [whitelist_recip<123@abc.com>] => undef, "123@abc.com" does not match
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) query_keys: root@ispconfig3.123.com, root@, ispconfig3.123.com, .ispconfig3.123.com, .123.com, .com, .
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup_hash(root@ispconfig3.123.com), no matches
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup [whitelist_sender<root@ispconfig3.123.com>,whitelis t_sender] => undef, "root@ispconfig3.123.com" does not match
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) query_keys: 123@abc.com, 123@, abc.com, .abc.com, .com, .
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup_hash(123@abc.com) matches keys: "."=>ARRAY(0xe39bae0)
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup [score_recip<123@abc.com>,score_sender], 1 matches for "123@abc.com", results: "."=>[Amavis::Lookup::RE=ARRAY(0xe39b820),HASH(0xe39b8b0 )]
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup_re("root@ispconfig3.123.com"), no matches
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) query_keys: root@ispconfig3.123.com, root@, ispconfig3.123.com, .ispconfig3.123.com, .123.com, .com, .
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup_hash(root@ispconfig3.123.com), no matches
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup [score_sender<root@ispconfig3.123.com>] => undef, "root@ispconfig3.123.com" does not match
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup [blacklist_recip<123@abc.com>] => undef, "123@abc.com" does not match
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) query_keys: sender@example.net, sender@, example.net, .example.net, .net, .
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup_hash(sender@example.net), no matches
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup [blacklist_sender<sender@example.net>,blacklist_sen der] => undef, "sender@example.net" does not match
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup [whitelist_recip<123@abc.com>] => undef, "123@abc.com" does not match
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) query_keys: sender@example.net, sender@, example.net, .example.net, .net, .
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup_hash(sender@example.net), no matches
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup [whitelist_sender<sender@example.net>,whitelist_sen der] => undef, "sender@example.net" does not match
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) query_keys: 123@abc.com, 123@, abc.com, .abc.com, .com, .
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup_hash(123@abc.com) matches keys: "."=>ARRAY(0xe39bae0)
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup [score_recip<123@abc.com>,score_sender], 1 matches for "123@abc.com", results: "."=>[Amavis::Lookup::RE=ARRAY(0xe39b820),HASH(0xe39b8b0 )]
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup_re("sender@example.net"), no matches
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) query_keys: sender@example.net, sender@, example.net, .example.net, .net, .
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup_hash(sender@example.net) matches key "sender@example.net", result=3
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup [score_sender<sender@example.net>] => true, "sender@example.net" matches, result="3", matching_key="sender@example.net"
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) wbl: soft-blacklisted (3) sender <sender@example.net> => <123@abc.com>, recip_key="."
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) spam_presence cached, skipping spam_scan
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) enqueue: stat is not numeric: ""
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup: (scalar) matches, result="2"
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup [spam_tag_level] => true, "123@abc.com" matches, result="2", matching_key="(constant:2)"
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup: (scalar) matches, result="6.2"
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup [spam_tag2_level] => true, "123@abc.com" matches, result="6.2", matching_key="(constant:6.2)"
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup [spam_tag3_level] => undef, "123@abc.com" does not match
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup: (scalar) matches, result="6.9"
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup [spam_kill_level] => true, "123@abc.com" matches, result="6.9", matching_key="(constant:6.9)"
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) final_destiny (ccat=6) is PASS, recip 123@abc.com
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) final_destiny (ccat=5) is PASS, recip 123@abc.com
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) final_destiny (ccat=0) is PASS, recip 123@abc.com
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) final_destiny PASS, recip 123@abc.com
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) do_notify_and_quar: ccat=Spam (6,0) ("6":Spam, "5":Spammy, "1,1":CleanTag, "1":Clean, "0":CatchAll) ccat_block=(), qar_mth=
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup: (scalar) matches, result="2"
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup [spam_tag_level] => true, "123@abc.com" matches, result="2", matching_key="(constant:2)"
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup: (scalar) matches, result="6.2"
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup [spam_tag2_level] => true, "123@abc.com" matches, result="6.2", matching_key="(constant:6.2)"
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup: (scalar) matches, result="6.9"
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup [spam_kill_level] => true, "123@abc.com" matches, result="6.9", matching_key="(constant:6.9)"
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup: (scalar) matches, result="spam-quarantine"
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup [spam_quarantine_to] => true, "123@abc.com" matches, result="spam-quarantine", matching_key="(constant:spam-quarantine)"
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup [spam_quarantine_cutoff_level] => undef, "123@abc.com" does not match
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) query_keys: 123@abc.com, 123@, abc.com, .abc.com, .com, .
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup_hash(123@abc.com), no matches
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup [spam_admin] => undef, "123@abc.com" does not match
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup [spam_quarantine_bysender_to] => undef, "root@ispconfig3.123.com" does not match
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) header: X-Spam-Flag: YES\n
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) header: X-Spam-Score: 1003.88\n
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) header: X-Spam-Level: ************************************************** **************\n
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) header: X-Spam-Status: Yes, score=1000.88+3 tag=2 tag2=6.2 kill=6.9 tests=[AM:BOOST=3,\n\tALL_TRUSTED=-1.44, DATE_IN_PAST_96_XX=2.32, GTUBE=1000]\n\tautolearn=unavailable\n
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) header: X-Quarantine-ID: <gTE40LXjoxuo>\n
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) header: X-Envelope-To-Blocked: \n
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) header: X-Envelope-To: <123@abc.com>\n
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) header: X-Envelope-From: <root@ispconfig3.123.com>\n
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) header: Received: from ispconfig3.123.com ([127.0.0.1])\n\tby localhost (ispconfig3.123.com [127.0.0.1]) (amavisd-new, port 10024)\n\twith ESMTP id gTE40LXjoxuo for <123@abc.com>;\n\tSun, 28 Feb 2010 10:53:35 +0800 (HKT)\n
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) DO_QUARANTINE, local:spam-%m.gz, <> -> spam-quarantine
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) dkim: not signing mail which is not originating from inside
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) local delivery: <> -> spam-quarantine, mbx=/var/virusmails/spam-gTE40LXjoxuo.gz
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) header: Delivered-To: spam-quarantine\n
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) header: Return-Path: <>\n
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) write_header: 0, Amavis::IO::Zlib=HASH(0x1193dad0)
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) one_response_for_all <>: success, r=0,b=0,d=0, ndn_needed=0, '250 2.6.0 Ok, delivered to /var/virusmails/spam-gTE40LXjoxuo.gz, id=05003-04'
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) DO_QUARANTINE done
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) SPAM, <root@ispconfig3.123.com> -> <123@abc.com>, Yes, score=1000.88+3 tag=2 tag2=6.2 kill=6.9 tests=[AM:BOOST=3, ALL_TRUSTED=-1.44, DATE_IN_PAST_96_XX=2.32, GTUBE=1000] autolearn=unavailable, quarantine gTE40LXjoxuo (spam-quarantine)
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) skip admin notification, no administrators
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) do_notify_and_quarantine - done
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup: (scalar) matches, result="2"
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup [spam_tag_level] => true, "123@abc.com" matches, result="2", matching_key="(constant:2)"
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup: (scalar) matches, result="6.2"
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup [spam_tag2_level] => true, "123@abc.com" matches, result="6.2", matching_key="(constant:6.2)"
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) headers CLUSTERING: NEW CLUSTER <123@abc.com>: score=1000.88+3, tag=1, tag2=1, local=0, bl=, s=, mangle=
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) header: X-Virus-Scanned: amavisd-new at example.com\n
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) header: Received: from ispconfig3.123.com ([127.0.0.1])\n\tby localhost (ispconfig3.123.com [127.0.0.1]) (amavisd-new, port 10024)\n\twith ESMTP id gTE40LXjoxuo for <123@abc.com>;\n\tSun, 28 Feb 2010 10:53:35 +0800 (HKT)\n
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) headers CLUSTERING: done all 1 recips in one go
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) dkim: not signing spam (from inside), From: <sender@example.net>
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) (about to connect to [127.0.0.1]:10025) FWD via SMTP: <root@ispconfig3.123.com> -> <123@abc.com>
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) smtp session reuse, 4 transactions so far
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) establish_or_refresh, state: ehlo
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) smtp cmd> NOOP
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) rw_loop: needline=0, flush=1, wr=1, timeout=15
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) rw_loop: sending
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) rw_loop sent 6> NOOP\r\n
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) rw_loop: needline=1, flush=0, wr=0, timeout=15
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) rw_loop: receiving
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) rw_loop read 14 chars< 250 2.0.0 Ok\r\n
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) smtp resp to NOOP (idle 211.4 s): 250 2.0.0 Ok
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) Remote host presents itself as: ispconfig3.123.com, handles DSN, handles PIPELINING
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) AUTH not needed, user='', MTA offers 'LOGIN PLAIN'
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) smtp cmd> MAIL FROM:<root@ispconfig3.123.com> BODY=7BIT
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) smtp cmd> RCPT TO:<123@abc.com> ORCPT=rfc822;123@abc.com
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) smtp cmd> DATA
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) rw_loop: needline=0, flush=1, wr=1, timeout=120
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) rw_loop: sending
Feb 28 02:53:37 ispconfig3 postfix/smtpd[5153]: 39C0F130F2C: client=unknown[127.0.0.1]
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) rw_loop sent 103> MAIL FROM:<root@ispconfig3.123.com> BODY=7BIT\r\nRCPT TO:<123@abc.com> ORCPT=rfc822;123@abc.com\r\nDATA\r\n
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) rw_loop: needline=1, flush=0, wr=0, timeout=300
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) rw_loop: receiving
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) rw_loop read 65 chars< 250 2.1.0 Ok\r\n250 2.1.5 Ok\r\n354 End data with <CR><LF>.<CR><LF>\r\n
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) smtp resp to MAIL (pip): 250 2.1.0 Ok
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) smtp resp to RCPT (pip) (<123@abc.com>): 250 2.1.5 Ok
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) smtp resp to DATA: 354 End data with <CR><LF>.<CR><LF>
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) write_header: 0, Amavis::Out::SMTP::Protocol=HASH(0x10dae890)
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) smtp cmd> QUIT
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) rw_loop: needline=0, flush=1, wr=1, timeout=478
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) rw_loop: sending
Feb 28 10:53:37 ispconfig3 postfix/cleanup[5606]: 39C0F130F2C: message-id=<GTUBE1.1010101@example.net>
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) rw_loop sent 1439> X-Virus-Scanned: amavisd-new at example.com\r\nReceived: from ispconfig3.123.com ([127.0.0.1])\r\n\tby localhost (ispconfig3.123.com [127.0.0.1]) (amavisd-new, port 10024)\r\n\twith ESMTP id gTE40LXjoxuo [...]
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) rw_loop: needline=1, flush=0, wr=0, timeout=478
Feb 28 10:53:37 ispconfig3 postfix/qmgr[2250]: 39C0F130F2C: from=<root@ispconfig3.123.com>, size=1599, nrcpt=1 (queue active)
Feb 28 02:53:37 ispconfig3 postfix/smtpd[5153]: disconnect from unknown[127.0.0.1]
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) rw_loop: receiving
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) rw_loop read 52 chars< 250 2.0.0 Ok: queued as 39C0F130F2C\r\n221 2.0.0 Bye\r\n
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) smtp resp to data-dot (<123@abc.com>): 250 2.0.0 Ok: queued as 39C0F130F2C
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) Amavis::Out::SMTP::Session close, disconnecting
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) prolong_timer fwd-end-chkpnt: timer set to 478 s
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) FWD via SMTP: <root@ispconfig3.123.com> -> <123@abc.com>,BODY=7BIT 250 2.0.0 Ok, id=05003-04, from MTA([127.0.0.1]:10025): 250 2.0.0 Ok: queued as 39C0F130F2C
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) prolong_timer forwarding: remaining time = 478 s
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) DSN: sender is credible (orig), SA: 1000.880, <root@ispconfig3.123.com>
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup: (scalar) matches, result="18"
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup => true, "root@ispconfig3.123.com" matches, result="18", matching_key="(constant:18)"
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) dsn: from MTA 250 NonBlocking:Spam <root@ispconfig3.123.com> -> <123@abc.com>: on_succ=0, on_dly=1, on_fail=1, never=0, warn_sender=, DSN_passed_on=1, mta_resp: "250 2.0.0 Ok, id=05003-04, from MTA([127.0.0.1]:10025): 250 2.0.0 Ok: queued as 39C0F130F2C"
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) DSN: SUCC from MTA 250 NonBlocking:Spam, no DSN requested: <root@ispconfig3.123.com> -> <123@abc.com>
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) one_response_for_all <root@ispconfig3.123.com>: success, r=0,b=0,d=0, ndn_needed=0, '250 2.0.0 Ok, id=05003-04, from MTA([127.0.0.1]:10025): 250 2.0.0 Ok: queued as 39C0F130F2C'
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) notif=N, suppressed=0, ndn_needed=0, exit=0, 250 2.0.0 Ok, id=05003-04, from MTA([127.0.0.1]:10025): 250 2.0.0 Ok: queued as 39C0F130F2C
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) prolong_timer delivery-notification: remaining time = 478 s
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) fish_out_ip_from_received: 127.0.0.1
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) lookup_ip_acl (publicnetworks): key="127.0.0.1" matches "!127.0.0.0/8", result=0
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) parse_ip_address_from_received: 127.0.0.1
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) Passed SPAM, MYNETS LOCAL [127.0.0.1] [127.0.0.1] <root@ispconfig3.123.com> -> <123@abc.com>, quarantine: spam-gTE40LXjoxuo.gz, Message-ID: <GTUBE1.1010101@example.net>, mail_id: gTE40LXjoxuo, Hits: 1003.88, size: 1170, queued_as: 39C0F130F2C, 1669 ms
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) prolong_timer main_log_entry: remaining time = 478 s
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) updating snmp variables
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) prolong_timer check done: remaining time = 478 s
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) sending SMTP response: "250 2.0.0 Ok, id=05003-04, from MTA([127.0.0.1]:10025): 250 2.0.0 Ok: queued as 39C0F130F2C"
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) ESMTP> 250 2.0.0 Ok, id=05003-04, from MTA([127.0.0.1]:10025): 250 2.0.0 Ok: queued as 39C0F130F2C
Feb 28 10:53:37 ispconfig3 postfix/smtp[5607]: 7DE05130F2A: to=<123@abc.com>, relay=127.0.0.1[127.0.0.1]:10024, delay=12, delays=10/0.01/0.01/1.7, dsn=2.0.0, status=sent (250 2.0.0 Ok, id=05003-04, from MTA([127.0.0.1]:10025): 250 2.0.0 Ok: queued as 39C0F130F2C)
Feb 28 10:53:37 ispconfig3 postfix/qmgr[2250]: 7DE05130F2A: removed
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) switch_to_client_time 480 s, smtp response sent
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) TempDir::strip: /var/amavis/tmp/amavis-20100228T104228-05003
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) rmdir_recursively: /var/amavis/tmp/amavis-20100228T104228-05003/parts, excl=1
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) TIMING [total 1693 ms] - SMTP greeting: 2 (0%)0, SMTP EHLO: 2 (0%)0, SMTP pre-MAIL: 2 (0%)0, SMTP pre-DATA-flush: 3 (0%)1, SMTP DATA: 28 (2%)2, check_init: 1 (0%)2, digest_hdr: 1 (0%)2, digest_body_dkim: 1 (0%)2, gen_mail_id: 1 (0%)2, mime_decode: 8 (0%)3, get-file-type1: 26 (2%)4, decompose_part: 2 (0%)5, parts_decode: 0 (0%)5, check_header: 3 (0%)5, AV-scan-1: 1510 (89%)94, spam-wb-list: 8 (0%)94, update_cache: 1 (0%)94, decide_mail_destiny: 3 (0%)95, notif-quar: 5 (0%)95, stat-mbx: 3 (0%)95, open-mbx: 0 (0%)95, write-header: 1 (0%)95, save-to-local-mailbox: 0 (0%)95, fwd-connect: 7 (0%)96, fwd-mail-pip: 7 (0%)96, fwd-rcpt-pip: 0 (0%)96, fwd-data-chkpnt: 0 (0%)96, write-header: 1 (0%)96, fwd-data-contents: 0 (0%)96, fwd-end-chkpnt: 33 (2%)98, prepare-dsn: 2 (0%)98, main_log_entry: 8 (0%)99, update_snmp: 3 (0%)99, SMTP pre-response: 18 (1%)100, SMTP response: 1 (0%)100, unlink-2-files: 1 (0%)100, rundown: 1 (0%)100
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) idle_proc, 6: was busy, 1684.9 ms, total idle 638.036 s, busy 31.083 s
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) idle_proc, 5: was idle, 0.2 ms, total idle 638.036 s, busy 31.083 s
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) ESMTP< QUIT\r\n
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) switch_to_my_time 480 s, SMTP QUIT received
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) ESMTP> 221 2.0.0 [127.0.0.1] amavisd-new closing transmission channel
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) switch_to_client_time 480 s, smtp response sent
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) SMTP session over, timer stopped
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) exiting process_request
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) post_process_request_hook: timer was not running
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) idle_proc, bye: was busy, 2.6 ms, total idle 638.036 s, busy 31.086 s
Feb 28 10:53:37 ispconfig3 amavis[5003]: (05003-04) load: 5 %, total idle 638.036 s, busy 31.086 s
Feb 28 10:53:37 ispconfig3 postfix/pipe[5611]: 39C0F130F2C: to=<123@abc.com>, relay=maildrop, delay=0.1, delays=0.02/0.01/0/0.07, dsn=2.0.0, status=sent (delivered via maildrop service)
Feb 28 10:53:37 ispconfig3 postfix/qmgr[2250]: 39C0F130F2C: removed
Feb 28 10:53:48 ispconfig3 imapd: Connection, ip=[::ffff:127.0.0.1]
Feb 28 10:53:48 ispconfig3 imapd: LOGIN, user=123@abc.com, ip=[::ffff:127.0.0.1], port=[59528], protocol=IMAP
Feb 28 10:53:48 ispconfig3 imapd: LOGOUT, user=123@abc.com, ip=[::ffff:127.0.0.1], headers=0, body=0, rcvd=87, sent=392, time=0
Reply With Quote
  #6  
Old 28th February 2010, 04:24
aclhkaclhk aclhkaclhk is offline
Junior Member
 
Join Date: Aug 2009
Posts: 29
Thanks: 0
Thanked 0 Times in 0 Posts
 
Default

if i changed $mydomain = 'abc.com' (default: example.com), spam header was inserted.

/etc/amavisd.conf
@local_domains_maps = ( [".$mydomain"] );

I wonder why it just points to mydomain (which hardcodes a domain name). It should do a db lookup, shouldn't it?
Reply With Quote
Reply

Bookmarks

Thread Tools
Display Modes

Posting Rules
You may not post new threads
You may not post replies
You may not post attachments
You may not edit your posts

BB code is On
Smilies are On
[IMG] code is On
HTML code is Off

Forum Jump

Similar Threads
Thread Thread Starter Forum Replies Last Post
Emails not delivered via btinternet.com despite 250 ok dirdel dwb Server Operation 0 4th January 2010 14:17
Amavis: DENIED ISPCONFIG: ACCESS from IP x.x.x.x DENIED / cant recieve emails KaiserGimmel Installation/Configuration 3 17th October 2009 23:16
cotrol de SPAM, amavis no funciona, not function, no destinate emails calivent Installation/Configuration 8 18th April 2009 22:00
seperating spam emails and real emails. Ryanmt General 1 25th March 2009 22:42
Moved mail to new server and now rejects emails. rmenzies Installation/Configuration 1 6th February 2007 09:14


All times are GMT +2. The time now is 06:37.


Powered by vBulletin® Version 3.8.7
Copyright ©2000 - 2014, vBulletin Solutions, Inc.