Nach Update 3.3 auf 3.4 werden keine Mails mehr zugestellt

Christian Nobis christian.nobis at gmail.com
Sa Apr 11 17:54:19 CEST 2015


Moin Moin,

ich habe seit etwa einem Jahr einen Kolab-Server auf einem Debian7 am
laufen, zunächst nur als Test, ob ich damit zurecht komme, als dann alles
so gut lief auch für eine private Domain im Live-Betrieb. Was ich nie
geprobt habe ist der Notfall ;-)

Nun habe ich gestern nach der Anleitung
https://docs.kolab.org/administrator-guide/upgrading-from-kolab-3.3-to-3.4.html
auf 3.4 aktualisert uns seitdem werden keine Mails mehr zugestellt.

In /var/log/mail.log sehe ich die Mails zwar durchlaufen, jedoch z.B.
fehlen im Gegensatz zu den Zustellungen vor dem Update die Aufrufe vom lmtp
auch nach extern werden keine Mails zugestellt:

Intern an Intern:
Apr 11 17:43:03 server postfix/smtpd[7616]: connect from
localhost.localdomain[127.0.0.1]
Apr 11 17:43:03 server postfix/smtpd[7616]: 875B4502FF:
client=localhost.localdomain[127.0.0.1], orig_queue_id=5BDAD42310,
orig_client=localhost.localdomain[127.0.0.1]
Apr 11 17:43:03 server postfix/cleanup[7617]: 875B4502FF: message-id=<
37569e23e2b1d9d1a5f99ae66e1c866e at nobis.li>
Apr 11 17:43:03 server postfix/smtpd[7616]: disconnect from
localhost.localdomain[127.0.0.1]
Apr 11 17:43:03 server postfix/qmgr[6217]: 875B4502FF: from=<
christian at nobis.li>, size=354, nrcpt=1 (queue active)
Apr 11 17:43:03 server amavis[2963]: (02963-07) Passed CLEAN
{RelayedInternal}, LOCAL [127.0.0.1]:46303 <christian at nobis.li> -> <
christian at nobis.li>, Queue-ID: 5BDAD42310, Message-ID: <
37569e23e2b1d9d1a5f99ae66e1c866e at nobis.li>, mail_id: 5GIt97rKP6gw, Hits: -,
size: 354, queued_as: 875B4502FF, 123 ms
Apr 11 17:43:03 server postfix/smtp[7614]: 5BDAD42310: to=<
christian at nobis.li>, relay=127.0.0.1[127.0.0.1]:10024, delay=0.43,
delays=0.29/0.01/0/0.12, 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 875B4502FF)
Apr 11 17:43:03 server postfix/qmgr[6217]: 5BDAD42310: removed
Apr 11 17:43:03 server postfix/smtp[7618]: 875B4502FF: to=<
christian at nobis.li>, relay=127.0.0.1[127.0.0.1]:10026, delay=0.04,
delays=0.02/0.01/0.01/0, dsn=2.0.0, status=sent (250 Ok)
Apr 11 17:43:03 server postfix/qmgr[6217]: 875B4502FF: removed

Intern an extern:

Apr 11 17:44:44 server postfix/submission/smtpd[7634]: connect from
localhost.localdomain[127.0.0.1]
Apr 11 17:44:44 server postfix/submission/smtpd[7634]: 4B9EE42310:
client=localhost.localdomain[127.0.0.1], sasl_method=LOGIN, sasl_username=
christian at nobis.li
Apr 11 17:44:44 server postfix/cleanup[7638]: 4B9EE42310: message-id=<
73db679c347914b16b4246bda3526c29 at nobis.li>
Apr 11 17:44:44 server postfix/qmgr[6217]: 4B9EE42310: from=<
christian at nobis.li>, size=361, nrcpt=1 (queue active)
Apr 11 17:44:44 server postfix/submission/smtpd[7634]: disconnect from
localhost.localdomain[127.0.0.1]
Apr 11 17:44:44 server imap[7461]: USAGE christian at nobis.li user: 0.006000
sys: 0.006000
Apr 11 17:44:44 server postfix/smtpd[7641]: connect from
localhost.localdomain[127.0.0.1]
Apr 11 17:44:44 server postfix/smtpd[7641]: 7672D5032A:
client=localhost.localdomain[127.0.0.1], orig_queue_id=4B9EE42310,
orig_client=localhost.localdomain[127.0.0.1]
Apr 11 17:44:44 server postfix/cleanup[7642]: 7672D5032A: message-id=<
73db679c347914b16b4246bda3526c29 at nobis.li>
Apr 11 17:44:44 server postfix/smtpd[7641]: disconnect from
localhost.localdomain[127.0.0.1]
Apr 11 17:44:44 server postfix/qmgr[6217]: 7672D5032A: from=<
christian at nobis.li>, size=361, nrcpt=1 (queue active)
Apr 11 17:44:44 server amavis[2964]: (02964-07) Passed CLEAN
{RelayedOutbound}, LOCAL [127.0.0.1]:46352 <christian at nobis.li> -> <
christian.nobis at gmail.com>, Queue-ID: 4B9EE42310, Message-ID: <
73db679c347914b16b4246bda3526c29 at nobis.li>, mail_id: sKzUoCLjaT_u, Hits: -,
size: 361, queued_as: 7672D5032A, 123 ms
Apr 11 17:44:44 server postfix/smtp[7639]: 4B9EE42310: to=<
christian.nobis at gmail.com>, relay=127.0.0.1[127.0.0.1]:10024, delay=0.43,
delays=0.29/0.01/0/0.12, 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 7672D5032A)
Apr 11 17:44:44 server postfix/qmgr[6217]: 4B9EE42310: removed
Apr 11 17:44:44 server postfix/smtp[7643]: 7672D5032A: to=<
christian.nobis at gmail.com>, relay=127.0.0.1[127.0.0.1]:10026, delay=0.04,
delays=0.02/0.01/0.01/0, dsn=2.0.0, status=sent (250 Ok)
Apr 11 17:44:44 server postfix/qmgr[6217]: 7672D5032A: removed


Ich habe das "Gefühl" das der Transport im postfix nicht funktioniert. Wenn
ich den cyrus neu starte, habe ich auch folgendes im log:

Apr 11 17:51:20 server master[7789]: setrlimit: Unable to set file
descriptors limit to -1: Operation not permitted
Apr 11 17:51:20 server master[7789]: retrying with 4096 (current max)
Apr 11 17:51:20 server ctl_cyrusdb[7790]: skiplist: clean shutdown file
missing, updating recovery stamp
Apr 11 17:51:20 server ctl_cyrusdb[7790]: recovering cyrus databases
Apr 11 17:51:20 server ctl_cyrusdb[7790]: done recovering cyrus databases
Apr 11 17:51:20 server master[7789]: unable to setsocketopt(IP_TOS) service
ptloader/unix: Operation not supported
Apr 11 17:51:20 server master[7789]: unable to setsocketopt(IP_TOS) service
lmtpunix/unix: Operation not supported
Apr 11 17:51:20 server master[7789]: unable to setsocketopt(IP_TOS) service
notify/unix: Operation not supported
Apr 11 17:51:20 server ctl_cyrusdb[7793]: checkpointing cyrus databases
Apr 11 17:51:20 server ctl_cyrusdb[7793]: done checkpointing cyrus databases

Der Socket ist aber unter /var/lib/imap/socket/lmtp neu erstellt und beim
Versand bekomme ich hier auch keine Fehlermeldungen, dass auf diesen nicht
zugegriffen werden könnte.

Vielen Dank

Christian
-------------- nächster Teil --------------
Ein Dateianhang mit HTML-Daten wurde abgetrennt...
URL: <http://lists.kolab.org/pipermail/users-de/attachments/20150411/b97d52fa/attachment.html>


Mehr Informationen über die Mailingliste users-de