[Postfixbuch-users] Mails verschwinden

[lars]

hi,

>> und die mail ist im Nirvana.....
>
> Ich würde sagen, nicht ganz. Postfix übergibt die Mail ja ganz
> normal an einen MTA auf 127.0.0.1 (wohl auf Port 10024), also
> wahrscheinlich amavisd-new. Der loggt ja auch irgendwohin, also
> müsste es darüber auch Aufzeichnungen geben.

vermutete ich auch, das amavis bzw. spamassassin nicht vernünftig 
laufen; hatte aber

1.) telnet 10024 getestet - meldet sich ordnungsgemäß
2) telnet 10025 - dito

3) loglevel in amavis auf 5; mail eingeliefert:

Oct 21 14:37:09 webmail amavisd-new[3587]: (03587-02) 
warnsender_with_pass=(,,,), dsn_needed=0, exit=0, 250 2.6.0 Ok, 
id=03587-02, from MTA: 250 Ok: queued as 4A63E8992F
Oct 21 14:37:09 webmail amavisd-new[3587]: (03587-02) Passed, 
<lars at brainlift.de> -> <a.draebelow at hfk-bremen.de>, Message-ID: 
<20041021123647.00BA08992E at webmail.hfk-bremen.de>, Hits: 3.595
Oct 21 14:37:09 webmail amavisd-new[3587]: (03587-02) sending SMTP 
response: "250 2.6.0 Ok, id=03587-02, from MTA: 250 Ok: queued as 
4A63E8992F"
Oct 21 14:37:09 webmail amavisd-new[3587]: (03587-02) timer stopped 
after DATA end
Oct 21 14:37:09 webmail amavisd-new[3587]: (03587-02) 
rmdir_recursively: /var/lib/amavis/amavis-20041021T143515-03587/parts, 
excl=1
Oct 21 14:37:09 webmail amavisd-new[3587]: (03587-02) TIMING [total 140 
ms] - SMTP EHLO: 2 (1%), SMTP pre-MAIL: 1 (1%), SMTP pre-DATA-flush: 2 
(1%), SMTP DATA: 38 (27%), body hash: 0 (0%), mime_decode: 5 (4%), 
get-file-type: 7 (5%), decompose_part: 1 (1%), parts: 0 (0%), 
AV-scan-1: 1 (1%), SA msg read: 2 (1%), SA parse: 1 (0%), SA check: 21 
(15%), fwd-connect: 6 (4%), fwd-mail-from: 1 (0%), fwd-rcpt-to: 2 (1%), 
write-header: 2 (1%), fwd-data: 0 (0%), fwd-data-end: 45 (32%), 
fwd-rundown: 2 (2%), unlink-1-files: 2 (2%), rundown: 0 (0%)
Oct 21 14:37:09 webmail amavisd-new[3587]: (03587-02) ESMTP> 250 2.6.0 
Ok, id=03587-02, from MTA: 250 Ok: queued as 4A63E8992F
Oct 21 14:37:09 webmail amavisd-new[3587]: (03587-02) prolong_timer 
after reading SMTP command: remaining time = 0 s
Oct 21 14:37:09 webmail amavisd-new[3587]: (03587-02) ESMTP< QUIT\r\n
Oct 21 14:37:09 webmail amavisd-new[3587]: (03587-02) ESMTP> 221 2.0.0 
[127.0.0.1] (amavisd) closing transmission channel

soweit ich amavis verstehe, sieht "closing transmission channel" OK aus.

4) per tcpdump -i lo mal mitgeschnitten, ob da was abläuft:

14:37:09.216515 IP localhost.localdomain.32977 > 
localhost.localdomain.10024: S 1995675702:1995675702(0) win 32767 <mss 
16396,sackOK,timestamp 9298987 0,nop,wscale 0>
14:37:09.216756 IP localhost.localdomain.10024 > 
localhost.localdomain.32977: S 1999229255:1999229255(0) ack 1995675703 
win 32767 <mss 16396,sackOK,timestamp 9298987 9298987,nop,wscale 0>
14:37:09.216779 IP localhost.localdomain.32977 > 
localhost.localdomain.10024: . ack 1 win 32767 <nop,nop,timestamp 
9298987 9298987>
14:37:09.217825 IP localhost.localdomain.10024 > 
localhost.localdomain.32977: P 1:50(49) ack 1 win 32767 
<nop,nop,timestamp 9298988 9298987>
14:37:09.217845 IP localhost.localdomain.32977 > 
localhost.localdomain.10024: . ack 50 win 32767 <nop,nop,timestamp 
9298988 9298988>
14:37:09.218303 IP localhost.localdomain.32977 > 
localhost.localdomain.10024: P 1:29(28) ack 50 win 32767 
<nop,nop,timestamp 9298988 9298988>
14:37:09.301203 IP localhost.localdomain.10025 > 
localhost.localdomain.32978: S 1990058206:1990058206(0) ack 2001217392 
win 32767 <mss 16396,sackOK,timestamp 9299071 9299071,nop,wscale 0>
14:37:09.301215 IP localhost.localdomain.32978 > 
localhost.localdomain.10025: . ack 1 win 32767 <nop,nop,timestamp 
9299071 9299071>
14:37:09.301562 IP localhost.localdomain.10025 > 
localhost.localdomain.32978: P 1:58(57) ack 1 win 32767 
<nop,nop,timestamp 9299072 9299071>
14:37:09.301575 IP localhost.localdomain.32978 > 
localhost.localdomain.10025: . ack 58 win 32767 <nop,nop,timestamp 
9299072 9299072>
14:37:09.302413 IP localhost.localdomain.32978 > 
localhost.localdomain.10025: P 1:17(16) ack 58 win 32767 
<nop,nop,timestamp 9299073 9299072>

- den rest spar ich uns ;-)
  Das problem ist ja auch wohl, dass eine lokale Maildir beliefert wird, 
er aber weder aliases noch den luser-parameter in der main.cf annimmt:

a) lokal vorhandene user werden beliefert (in den Logs sehen 
amavisd-tests OK aus)
b) lokal vorhandene user werden beliefert, auch, wenn per alias-Eintrag 
forwarded werden müsste
c) mails lokal nicht vorhandene user verschwinden auf für mich nicht 
nachvollziehbare weise

ich habe die main.cf soeben nochmal auf typos durchsucht, 
ursprungsconfigs eingespielt - alles wirkungslos.

> Wohin forwarded denn der amavis?

keine ahnung - ist jemand anders schlauer als ich / wir??

ich such erstmal weiter....

gruss

lars