Package: exim4_4.82-5_all
Version: 4.82-5
I have 4 exim4 packages installed for each version. When I updated exim4 from
4.80-4 to 4.82-5, exim broke since it would not output email to my smart-host.
The logs said that the smart-host said "Relaying denied. Proper authentation
required." I wrote a test script which ran exim with -d (debug) for both
versions (4.80 and 4.82). The debug output is attached as a wdiff file showing
the difference between the output for 4.80 and 4.82.
What is observed from looking at this debug output is: After my exim and the
smart-host (server) agree on "using PIPELINING" both versions of exim find my
name and password. But next they do "scanning authentication mechanisms" quite
differenly. 4.80 looks up my password twice more (wasted effort since my
passwork has already been found). It then sends authentication to the server
by SMPT>> AUTH PLAIN *****..** and the server responds "OK Authenticated".
Then the header FROM: TO: and DATA is sent to the sever.
But 4.82 just skips any authentication and sends FROM: TO: and DATA to the
server OK. The server say the sender is OK but then after repeating the TO:
address says "Relaying denied. Proper authentation required." It's obvious
this is happening because of the failure of 4.82 to send any authentication to
the server.
David Lawyer
Diff results (wdiff) for debugging exim4 4.80 (blue) and 4.82 (red). Use "cat
eximdiff | colordiff | most" to view in color.
-----------------------------------------------------------------------------
Exim version [-4.82-] {+4.80+} uid=1000 gid=1000 [-pid=7714-] {+pid=5093+}
D=fbb95cfd
Berkeley DB: Berkeley DB [-5.3.28: (September 9, 2013)-] {+5.1.29: (October
25, 2011)+}
Support for: crypteq iconv() IPv6 GnuTLS move_frozen_messages DKIM
Lookups (built-in): lsearch wildlsearch nwildlsearch iplsearch cdb dbm dbmjz
dbmnz dnsdb dsearch nis nis0 passwd
Authenticators: cram_md5 plaintext
Routers: accept dnslookup ipliteral manualroute queryprogram redirect
Transports: appendfile/maildir/mailstore autoreply lmtp pipe smtp
Fixed never_users: 0
Size of off_t: 8
Compiler: GCC [-[4.8.2]-] {+[4.7.0]+}
Library version: GnuTLS: Compile: [-2.12.23-] {+2.12.20+}
Runtime: 2.12.23
Library version: PCRE: Compile: [-8.31-] {+8.30+}
Runtime: 8.31 2012-07-06
Total 13 lookups
WHITELIST_D_MACROS: "OUTGOING"
TRUSTED_CONFIG_LIST: "/etc/exim4/trusted_configs"
changed uid/gid: forcing real = effective
uid=0 gid=1000 [-pid=7714-] {+pid=5093+}
auxiliary group list: <none>
seeking password data for user "uucp": cache not available
getpwnam() succeeded uid=10 gid=10
changed uid/gid: calling tls_validate_require_cipher
uid=107 gid=107 [-pid=7715-] {+pid=5094+}
auxiliary group list: <none>
tls_validate_require_cipher child [-7715-] {+5094+} ended: status=0x0
configuration file is /var/lib/exim4/config.autogenerated
log selectors = 00000ffc [-00632001-] {+00612001+}
cwd=/home/dave 3 args: [-exim -d+auth-] {+/usr/sbin/exim -d+tls+}
christine...@gmail.com
admin user
changed uid/gid: privilege not needed
uid=107 gid=107 [-pid=7714-] {+pid=5093+}
auxiliary group list: 107
seeking password data for user "mail": cache not available
getpwnam() succeeded uid=8 gid=8
user name "David Lawyer" extracted from gecos field "David Lawyer,,,,"
originator: uid=1000 gid=1000 login=dave name=David Lawyer
sender address = dave@daveslinux
set_process_info: [-7714-] {+5093+} accepting a local non-SMTP message from
<dave@daveslinux>
Sender: dave@daveslinux
Recipients:
christine...@gmail.com
search_tidyup called
>>Headers received:
From: d...@lafn.org
To: christine...@gmail.com
Subject: [-test-]
[--]
[-address match-] test: {+Don't reply+}
{++}
{+address match:+} subject=christine...@gmail.com pattern=d...@lafn.org
christine...@gmail.com in "d...@lafn.org"? no (end of list)
address [-match test:-] {+match:+} subject=dave@daveslinux
pattern=*@+local_domains
daveslinux in "@:localhost"? yes (matched "@")
daveslinux in "+local_domains"? yes (matched "+local_domains")
dave@daveslinux in "*@+local_domains"? yes (matched "*@+local_domains")
search_open: lsearch "/etc/email-addresses"
search_find: file="/etc/email-addresses"
key="dave" partial=-1 affix=NULL starflags=0
LRU list:
7/etc/email-addresses
End
internal_search_find: file="/etc/email-addresses"
type=lsearch key="dave"
file lookup required for dave
in /etc/email-addresses
lookup yielded: d...@lafn.org
LOG: address_rewrite MAIN
"dave@daveslinux" from env-from rewritten as "d...@lafn.org" by rule 2
address [-match test:-] {+match:+} subject=d...@lafn.org pattern=*@daveslinux
lafn.org in "daveslinux"? no (end of list)
d...@lafn.org in "*@daveslinux"? no (end of list)
rewritten sender = d...@lafn.org
rewrite_one_header: type=F:
From: d...@lafn.org
address [-match test:-] {+match:+} subject=d...@lafn.org
pattern=*@+local_domains
lafn.org in "@:localhost"? no (end of list)
lafn.org in "+local_domains"? no (end of list)
d...@lafn.org in "*@+local_domains"? no (end of list)
address [-match test:-] {+match:+} subject=d...@lafn.org pattern=*@daveslinux
lafn.org in "daveslinux"? no (end of list)
d...@lafn.org in "*@daveslinux"? no (end of list)
rewrite_one_header: type=T:
To: christine...@gmail.com
search_tidyup called
>>Headers after rewriting and local additions:
F From: d...@lafn.org
T To: christine...@gmail.com
Subject: [-test-] {+test: Don't reply+}
I Message-Id: [-<E1WT43z-00020Q-9d@daveslinux>-]
{+<E1WTGtR-0001K9-L7@daveslinux>+}
* X-rewrote-sender: dave@daveslinux
Date: [-Wed, 26-] {+Thu, 27+} Mar 2014 [-23:46:27-] {+13:27:17+} -0700
Data file written for message [-1WT43z-00020Q-9d-] {+1WTGtR-0001K9-L7+}
>>Generated Received: header line
P Received: from dave by daveslinux with local (Exim [-4.82)-] {+4.80)+}
(envelope-from <d...@lafn.org>)
id [-1WT43z-00020Q-9d-] {+1WTGtR-0001K9-L7+}
for christine...@gmail.com; [-Wed, 26-] {+Thu, 27+} Mar 2014
[-23:46:28-] {+13:27:17+} -0700
calling local_scan(); timeout=300
local_scan() returned 0 NULL
Writing spool header file
Size of headers = [-314-] {+327+}
LOG: MAIN
<= d...@lafn.org U=dave P=local [-S=320-] {+S=662+}
search_tidyup called
search_tidyup called
[-exec /usr/sbin/exim4 -d=0xfbb95cfd -Mc 1WT43z-00020Q-9d-]
>>>>>>>>>>>>>>>> Exim [-pid=7714-] {+pid=5093+} terminating with rc=0
>>>>>>>>>>>>>>>> >>>>>>>>>>>>>>>>
{+exec /usr/sbin/exim4 -d=0xfbb95cfd -Mc 1WTGtR-0001K9-L7+}
Exim version [-4.82-] {+4.80+} uid=107 gid=107 [-pid=7716-] {+pid=5095+}
D=fbb95cfd
Berkeley DB: Berkeley DB [-5.3.28: (September 9, 2013)-] {+5.1.29: (October
25, 2011)+}
Support for: crypteq iconv() IPv6 GnuTLS move_frozen_messages DKIM
Lookups (built-in): lsearch wildlsearch nwildlsearch iplsearch cdb dbm dbmjz
dbmnz dnsdb dsearch nis nis0 passwd
Authenticators: cram_md5 plaintext
Routers: accept dnslookup ipliteral manualroute queryprogram redirect
Transports: appendfile/maildir/mailstore autoreply lmtp pipe smtp
Fixed never_users: 0
Size of off_t: 8
Compiler: GCC [-[4.8.2]-] {+[4.7.0]+}
Library version: GnuTLS: Compile: [-2.12.23-] {+2.12.20+}
Runtime: 2.12.23
Library version: PCRE: Compile: [-8.31-] {+8.30+}
Runtime: 8.31 2012-07-06
Total 13 lookups
WHITELIST_D_MACROS: "OUTGOING"
TRUSTED_CONFIG_LIST: "/etc/exim4/trusted_configs"
changed uid/gid: forcing real = effective
uid=0 gid=107 [-pid=7716-] {+pid=5095+}
auxiliary group list: <none>
seeking password data for user "uucp": cache not available
getpwnam() succeeded uid=10 gid=10
changed uid/gid: calling tls_validate_require_cipher
uid=107 gid=107 [-pid=7717-] {+pid=5096+}
auxiliary group list: <none>
tls_validate_require_cipher child [-7717-] {+5096+} ended: status=0x0
configuration file is /var/lib/exim4/config.autogenerated
log selectors = 00000ffc [-00632001-] {+00612001+}
cwd=/var/spool/exim4 4 args: /usr/sbin/exim4 -d=0xfbb95cfd -Mc
[-1WT43z-00020Q-9d-] {+1WTGtR-0001K9-L7+}
trusted user
admin user
{+skipping ACL configuration - not needed+}
seeking password data for user "mail": cache not available
getpwnam() succeeded uid=8 gid=8
set_process_info: [-7716-] {+5095+} delivering specified messages
set_process_info: [-7716-] {+5095+} delivering [-1WT43z-00020Q-9d-]
{+1WTGtR-0001K9-L7+}
reading spool file [-1WT43z-00020Q-9d-H-] {+1WTGtR-0001K9-L7-H+}
user=dave uid=1000 gid=1000 sender=d...@lafn.org
sender_local=1 ident=dave
Non-recipients:
Empty Tree
---- End of tree ----
recipients_count=1
body_linecount=1 message_linecount=9
Delivery address list:
christine...@gmail.com
locking /var/spool/exim4/db/retry.lockfile
locked /var/spool/exim4/db/retry.lockfile
EXIM_DBOPEN(/var/spool/exim4/db/retry)
returned from EXIM_DBOPEN
no retry data available
>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
Considering: christine...@gmail.com
unique = christine...@gmail.com
no domain retry record
no address retry record
christine...@gmail.com: queued for routing
>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
routing christine...@gmail.com
--------> hubbed_hosts router <--------
local_part=christine256 domain=gmail.com
checking domains
expansion of "${if
exists{/etc/exim4/hubbed_hosts}{partial-lsearch;/etc/exim4/hubbed_hosts}fail}"
forced failure: assume not in this list
hubbed_hosts router skipped: domains mismatch
--------> smarthost router <--------
local_part=christine256 domain=gmail.com
checking domains
gmail.com in "@:localhost"? no (end of list)
gmail.com in "! +local_domains"? yes (end of list)
R: smarthost for christine...@gmail.com
calling smarthost router
smarthost router called for christine...@gmail.com
domain = gmail.com
route_item = * smtp.lafn.org byname
gmail.com in "*"? yes (matched "*")
original list of hosts = "smtp.lafn.org" options = byname
expanded list of hosts = "smtp.lafn.org" options = byname
set transport remote_smtp_smarthost
finding IP address for smtp.lafn.org
calling host_find_byname
gethostbyname2(af=inet6) returned 3 (NO_RECOVERY)
fully qualified name = zoom.lafn.org
gethostbyname2 looked up these IP addresses:
name=zoom.lafn.org address=108.92.93.123
queued for remote_smtp_smarthost transport: local_part = christine256
domain = gmail.com
errors_to=NULL
domain_data=NULL localpart_data=NULL
routed by smarthost router
envelope to: christine...@gmail.com
transport: remote_smtp_smarthost
host zoom.lafn.org [108.92.93.123]
>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
After routing:
Local deliveries:
Remote deliveries:
christine...@gmail.com
Failed addresses:
Deferred addresses:
search_tidyup called
>>>>>>>>>>>>>>>> Remote deliveries >>>>>>>>>>>>>>>>
--------> christine...@gmail.com <--------
search_tidyup called
set_process_info: [-7716-] {+5095+} delivering [-1WT43z-00020Q-9d:-]
{+1WTGtR-0001K9-L7:+} waiting for a remote delivery subprocess to finish
selecting on subprocess pipes
changed uid/gid: remote delivery to christine...@gmail.com with
transport=remote_smtp_smarthost
uid=107 gid=107 [-pid=7718-] {+pid=5097+}
auxiliary group list: <none>
set_process_info: [-7718-] {+5097+} delivering [-1WT43z-00020Q-9d-]
{+1WTGtR-0001K9-L7+} using remote_smtp_smarthost
T: remote_smtp_smarthost for christine...@gmail.com
remote_smtp_smarthost transport entered
christine...@gmail.com
gmail.com in queue_smtp_domains? no (option unset)
checking status of zoom.lafn.org
locking /var/spool/exim4/db/retry.lockfile
locked /var/spool/exim4/db/retry.lockfile
EXIM_DBOPEN(/var/spool/exim4/db/retry)
returned from EXIM_DBOPEN
no retry data available
zoom.lafn.org [108.92.93.123] status = usable
108.92.93.123 in serialize_hosts? no (option unset)
delivering [-1WT43z-00020Q-9d-] {+1WTGtR-0001K9-L7+} to zoom.lafn.org
[108.92.93.123] (christine...@gmail.com)
set_process_info: [-7718-] {+5097+} delivering [-1WT43z-00020Q-9d-]
{+1WTGtR-0001K9-L7+} to zoom.lafn.org [108.92.93.123] (christine...@gmail.com)
Connecting to zoom.lafn.org [108.92.93.123]:25 ... connected
waiting for data on socket
read response data: size=87
SMTP<< 220 zoom.lafn.org ESMTP Sendmail 8.14.7/8.14.2; [-Wed, 26-] {+Thu,
27+} Mar 2014 [-23:46:29-] {+13:27:19+} -0700 (PDT)
108.92.93.123 in hosts_avoid_esmtp? no (option unset)
SMTP>> EHLO daveslinux
waiting for data on socket
read response data: [-size=266-] {+size=268+}
SMTP<< 250-zoom.lafn.org Hello [-66-81-120-83.socal.dialup.o1.com
[66.81.120.83],-] {+66-81-120-135.socal.dialup.o1.com [66.81.120.135],+}
pleased to meet you
250-ENHANCEDSTATUSCODES
250-PIPELINING
250-EXPN
250-VERB
250-8BITMIME
250-SIZE
250-DSN
250-ETRN
250-AUTH GSSAPI LOGIN PLAIN
250-STARTTLS
250-DELIVERBY
250 HELP
108.92.93.123 in hosts_avoid_tls? no (option unset)
SMTP>> STARTTLS
waiting for data on socket
read response data: size=30
SMTP<< 220 2.0.0 Ready to start TLS
initialising GnuTLS as a client on fd 6
GnuTLS global init required.
initialising GnuTLS client session
Expanding various TLS configuration options for session credentials.
TLS: no client certificate specified; okay
TLS: tls_verify_certificates not set or empty, ignoring
GnuTLS using default session cipher/priority "NORMAL"
WARNING: tls_dh_min_bits far too low, clamping 52 up to 512
Setting D-H prime minimum acceptable bits to 512
TLS: server certificate verification not required
gnutls_handshake was successful
cipher: TLS1.0:DHE_RSA_AES_128_CBC_SHA1:128
Have channel bindings cached for possible auth usage.
SMTP>> EHLO daveslinux
[-tls_do_write(0xbf9384bc,-]
{+tls_do_write(0xbff2abfc,+} 17)
gnutls_record_send(SSL, [-0xbf9384bc,-] {+0xbff2abfc,+} 17)
outbytes=17
waiting for data on socket
Calling [-gnutls_record_recv(0xb88f3a18, 0xbf9398bc,-]
{+gnutls_record_recv(0xb8e6e6e8, 0xbff2bffc,+} 4096)
read response data: [-size=252-] {+size=254+}
SMTP<< 250-zoom.lafn.org Hello [-66-81-120-83.socal.dialup.o1.com
[66.81.120.83],-] {+66-81-120-135.socal.dialup.o1.com [66.81.120.135],+}
pleased to meet you
250-ENHANCEDSTATUSCODES
250-PIPELINING
250-EXPN
250-VERB
250-8BITMIME
250-SIZE
250-DSN
250-ETRN
250-AUTH GSSAPI LOGIN PLAIN
250-DELIVERBY
250 HELP
108.92.93.123 in hosts_avoid_pipelining? no (option unset)
using PIPELINING
108.92.93.123 in hosts_require_auth? no (option unset)
search_open: nwildlsearch "/etc/exim4/passwd.client"
search_find: file="/etc/exim4/passwd.client"
key="zoom.lafn.org" partial=-1 affix=NULL starflags=0
LRU list:
:/etc/exim4/passwd.client
End
internal_search_find: file="/etc/exim4/passwd.client"
type=nwildlsearch key="zoom.lafn.org"
file lookup required for zoom.lafn.org
in /etc/exim4/passwd.client
zoom.lafn.org in "zoom.lafn.org"? yes (matched "zoom.lafn.org")
lookup yielded: dave:vorkut
108.92.93.123 in hosts_try_auth? yes (matched "108.92.93.123")
scanning authentication mechanisms
{+search_open: nwildlsearch "/etc/exim4/passwd.client"+}
{+ cached open+}
{+search_find: file="/etc/exim4/passwd.client"+}
{+ key="zoom.lafn.org" partial=-1 affix=NULL starflags=0+}
{+LRU list:+}
{+ :/etc/exim4/passwd.client+}
{+ End+}
{+internal_search_find: file="/etc/exim4/passwd.client"+}
{+ type=nwildlsearch key="zoom.lafn.org"+}
{+cached data used for lookup of zoom.lafn.org+}
{+ in /etc/exim4/passwd.client+}
{+lookup yielded: dave:vorkut+}
{+search_open: nwildlsearch "/etc/exim4/passwd.client"+}
{+ cached open+}
{+search_find: file="/etc/exim4/passwd.client"+}
{+ key="zoom.lafn.org" partial=-1 affix=NULL starflags=0+}
{+LRU list:+}
{+ :/etc/exim4/passwd.client+}
{+ End+}
{+internal_search_find: file="/etc/exim4/passwd.client"+}
{+ type=nwildlsearch key="zoom.lafn.org"+}
{+cached data used for lookup of zoom.lafn.org+}
{+ in /etc/exim4/passwd.client+}
{+lookup yielded: dave:vorkut+}
{+ SMTP>> AUTH PLAIN ****************+}
{+tls_do_write(0xbff2abfc, 29)+}
{+gnutls_record_send(SSL, 0xbff2abfc, 29)+}
{+outbytes=29+}
{+waiting for data on socket+}
{+Calling gnutls_record_recv(0xb8e6e6e8, 0xbff2bffc, 4096)+}
{+read response data: size=28+}
{+ SMTP<< 235 2.0.0 OK Authenticated+}
plain authenticator yielded [-13-]
[-login authenticator yielded 13-] {+0+}
SMTP>> MAIL FROM:<d...@lafn.org> [-SIZE=1354-] {+SIZE=1696
AUTH=dave@daveslinux+}
SMTP>> RCPT TO:<christine...@gmail.com>
SMTP>> DATA
[-tls_do_write(0xbf9384bc, 77)-]
{+tls_do_write(0xbff2abfc, 98)+}
gnutls_record_send(SSL, [-0xbf9384bc, 77)-]
[-outbytes=77-] {+0xbff2abfc, 98)+}
{+outbytes=98+}
waiting for data on socket
Calling [-gnutls_record_recv(0xb88f3a18, 0xbf9398bc,-]
{+gnutls_record_recv(0xb8e6e6e8, 0xbff2bffc,+} 4096)
read response data: [-size=161-] {+size=142+}
SMTP<< 250 2.1.0 <d...@lafn.org>... Sender ok
SMTP<< [-550 5.7.1-] {+250 2.1.5+} <christine...@gmail.com>... [-Relaying
denied. Proper authentication required.-] {+Recipient ok+}
SMTP<< [-503 5.0.0 Need RCPT (recipient)-]
[-SMTP error from remote mail server after pipelined DATA: host zoom.lafn.org
[108.92.93.123]: 503 5.0.0 Need RCPT (recipient)-]
[-error for DATA ignored: pipelining is in use-] {+354 Enter mail, end with "."
on a line by itself+}
{+ SMTP>> writing message+} and [-there were no good recipients-]
{+terminating "."+}
{+writing data block fd=6 size=677 timeout=300+}
{+tls_do_write(0xb8e5a740, 677)+}
{+gnutls_record_send(SSL, 0xb8e5a740, 677)+}
{+outbytes=677+}
{+waiting for data on socket+}
{+Calling gnutls_record_recv(0xb8e6e6e8, 0xbff2bffc, 4096)+}
{+read response data: size=56+}
{+ SMTP<< 250 2.0.0 s2RKRJFF008163 Message accepted for delivery+}
{+journalling christine...@gmail.com+}
ok=1 send_quit=1 [-send_rset=1-] {+send_rset=0+} continue_more=0 yield=0
first_address is NULL
108.92.93.123 in hosts_nopass_tls? no (option unset)
transport_check_waiting entered
sequence=1 local_max=500 global_max=-1
locking /var/spool/exim4/db/wait-remote_smtp_smarthost.lockfile
locked /var/spool/exim4/db/wait-remote_smtp_smarthost.lockfile
EXIM_DBOPEN(/var/spool/exim4/db/wait-remote_smtp_smarthost)
returned from EXIM_DBOPEN
opened hints database /var/spool/exim4/db/wait-remote_smtp_smarthost:
flags=O_RDWR
dbfn_read: key=zoom.lafn.org
no messages waiting for zoom.lafn.org
SMTP>> QUIT
[-tls_do_write(0xbf9384bc,-]
{+tls_do_write(0xbff2abfc,+} 6)
gnutls_record_send(SSL, [-0xbf9384bc,-] {+0xbff2abfc,+} 6)
outbytes=6
tls_close(): shutting down TLS
set_process_info: [-7718-] {+5097+} delivering [-1WT43z-00020Q-9d:-]
{+1WTGtR-0001K9-L7:+} just tried zoom.lafn.org [108.92.93.123] for
christine...@gmail.com: result OK
Leaving remote_smtp_smarthost transport
set_process_info: [-7718-] {+5097+} delivering [-1WT43z-00020Q-9d-]
{+1WTGtR-0001K9-L7+} (just run remote_smtp_smarthost for christine...@gmail.com
in subprocess)
search_tidyup called
reading pipe for subprocess [-7718-] {+5097+} (not ended)
read() yielded 5
selecting on subprocess pipes
reading pipe for subprocess [-7718-] {+5097+} (not ended)
read() yielded 129
selecting on subprocess pipes
reading pipe for subprocess [-7718-] {+5097+} (not ended)
read() yielded [-213-] {+47+}
selecting on subprocess pipes
reading pipe for subprocess [-7718-] {+5097+} (not ended)
read() yielded 2
Z0 item read
remote delivery process [-7718-] {+5097+} ended
set_process_info: [-7716-] {+5095+} delivering [-1WT43z-00020Q-9d-]
{+1WTGtR-0001K9-L7+}
post-process christine...@gmail.com [-(2)-] {+(0)+}
{+christine...@gmail.com delivered+}
LOG: MAIN
[-**-]
{+=>+} christine...@gmail.com R=smarthost [-T=remote_smtp_smarthost: SMTP
error from remote mail server after RCPT TO:<christine...@gmail.com>: host
zoom.lafn.org [108.92.93.123]: 550 5.7.1 <christine...@gmail.com>... Relaying
denied. Proper authentication required.-] {+T=remote_smtp_smarthost
H=zoom.lafn.org [108.92.93.123] X=TLS1.0:DHE_RSA_AES_128_CBC_SHA1:128
DN="C=US,ST=California,L=Los Angeles,O=LA
Free-Net,OU=ops,CN=smtp.lafn.org,EMAIL=bc...@lafn.org"+}
>>>>>>>>>>>>>>>> deliveries are done >>>>>>>>>>>>>>>>
changed uid/gid: post-delivery tidying
uid=107 gid=107 [-pid=7716-] {+pid=5095+}
auxiliary group list: <none>
set_process_info: [-7716-] {+5095+} tidying up after delivering
[-1WT43z-00020Q-9d-] {+1WTGtR-0001K9-L7+}
Processing retry items
Succeeded addresses:
[-Failed addresses:-]
christine...@gmail.com: no retry items
[-Deferred addresses:-]
[-end of retry processing-]
[-processing failed address christine...@gmail.com-]
[-exec /usr/sbin/exim4 -d=0xfbb95cfd -t -oem -oi -f <> -E1WT43z-00020Q-9d-]
[-sending error message to: d...@lafn.org-]
[-writing data block fd=8 size=349 timeout=0-]
[-Exim version 4.82 uid=107 gid=107 pid=7719 D=fbb95cfd-]
[-Berkeley DB: Berkeley DB 5.3.28: (September 9, 2013)-]
[-Support for: crypteq iconv() IPv6 GnuTLS move_frozen_messages DKIM-]
[-Lookups (built-in): lsearch wildlsearch nwildlsearch iplsearch cdb dbm dbmjz
dbmnz dnsdb dsearch nis nis0 passwd-]
[-Authenticators: cram_md5 plaintext-]
[-Routers: accept dnslookup ipliteral manualroute queryprogram redirect-]
[-Transports: appendfile/maildir/mailstore autoreply lmtp pipe smtp-]
[-Fixed never_users: 0-]
[-Size of off_t: 8-]
[-Compiler: GCC [4.8.2]-]
[-Library version: GnuTLS: Compile: 2.12.23-]
[- Runtime: 2.12.23-]
[-Library version: PCRE: Compile: 8.31-]
[- Runtime: 8.31 2012-07-06-]
[-Total 13 lookups-]
[-WHITELIST_D_MACROS: "OUTGOING"-]
[-TRUSTED_CONFIG_LIST: "/etc/exim4/trusted_configs"-]
[-changed uid/gid: forcing real = effective-]
[- uid=0 gid=107 pid=7719-]
[- auxiliary group list: <none>-]
[-seeking password data for user "uucp": cache not available-]
[-getpwnam() succeeded uid=10 gid=10-]
[-changed uid/gid: calling tls_validate_require_cipher-]
[- uid=107 gid=107 pid=7720-]
[- auxiliary group list: <none>-]
[-tls_validate_require_cipher child 7720 ended: status=0x0-]
[-configuration file is /var/lib/exim4/config.autogenerated-]
[-log selectors = 00000ffc 00632001-]
[-cwd=/var/spool/exim4 8 args: /usr/sbin/exim4 -d=0xfbb95cfd -t -oem -oi -f <>
-E1WT43z-00020Q-9d-]
[-trusted user-]
[-admin user-]
[-changed uid/gid: privilege not needed-]
[- uid=107 gid=107 pid=7719-]
[- auxiliary group list: 107-]
[-seeking password data for user "mail": cache not available-]
[-getpwnam() succeeded uid=8 gid=8-]
[-originator: uid=107 gid=107 login=Debian-exim name=-]
[-sender address = -]
[-set_process_info: 7719 accepting a local non-SMTP message from <>-]
[-Sender: -]
[-search_tidyup called-]
[->>Headers received:-]
[-X-Failed-Recipients: christine...@gmail.com-]
[-Auto-Submitted: auto-replied-]
[-From: Mail Delivery System <Mailer-Daemon@daveslinux>-]
[-To: d...@lafn.org-]
[-Subject: Mail delivery failed: returning message to sender-]
[--]
[-address match test: subject=d...@lafn.org pattern=d...@lafn.org-]
[-lafn.org in "lafn.org"? yes (matched "lafn.org")-]
[-d...@lafn.org in "d...@lafn.org"? yes (matched "d...@lafn.org")-]
[-LOG: address_rewrite MAIN-]
[- "d...@lafn.org" from env-to rewritten as "dave@daveslinux" by rule 1-]
[-rewrite_one_header: type=F:-]
[- From: Mail Delivery System <Mailer-Daemon@daveslinux>-]
[-address match test: subject=Mailer-Daemon@daveslinux
pattern=*@+local_domains-]
[-daveslinux in "@:localhost"? yes (matched "@")-]
[-daveslinux in "+local_domains"? yes (matched "+local_domains")-]
[-Mailer-Daemon@daveslinux in "*@+local_domains"? yes (matched
"*@+local_domains")-]
[-search_open: lsearch "/etc/email-addresses"-]
[-search_find: file="/etc/email-addresses"-]
[- key="Mailer-Daemon" partial=-1 affix=NULL starflags=0-]
[-LRU list:-]
[- 7/etc/email-addresses-]
[- End-]
[-internal_search_find: file="/etc/email-addresses"-]
[- type=lsearch key="Mailer-Daemon"-]
[-file lookup required for Mailer-Daemon-]
[- in /etc/email-addresses-]
[-lookup failed-]
[-address match test: subject=Mailer-Daemon@daveslinux pattern=*@daveslinux-]
[-daveslinux in "daveslinux"? yes (matched "daveslinux")-]
[-Mailer-Daemon@daveslinux in "*@daveslinux"? yes (matched "*@daveslinux")-]
[-search_open: lsearch "/etc/email-addresses"-]
[- cached open-]
[-search_find: file="/etc/email-addresses"-]
[- key="Mailer-Daemon" partial=-1 affix=NULL starflags=0-]
[-LRU list:-]
[- 7/etc/email-addresses-]
[- End-]
[-internal_search_find: file="/etc/email-addresses"-]
[- type=lsearch key="Mailer-Daemon"-]
[-cached data used for lookup of Mailer-Daemon-]
[- in /etc/email-addresses-]
[-lookup failed-]
[-rewrite_one_header: type=T:-]
[- To: d...@lafn.org-]
[-search_tidyup called-]
[->>Headers after rewriting and local additions:-]
[- X-Failed-Recipients: christine...@gmail.com-]
[- Auto-Submitted: auto-replied-]
[-F From: Mail Delivery System <Mailer-Daemon@daveslinux>-]
[-T To: d...@lafn.org-]
[- Subject: Mail delivery failed: returning message to sender-]
[-I Message-Id: <E1WT45C-00020V-Lq@daveslinux>-]
[-* X-rewrote-original-recipient: d...@lafn.org-]
[- Date: Wed, 26 Mar 2014 23:46:34 -0700-]
[--]
[-Data file written for message 1WT45C-00020V-Lq-]
[->>Generated Received: header line-]
[-P Received: from Debian-exim by daveslinux with local (Exim 4.82)-]
[- id 1WT45C-00020V-Lq-]
[- for dave@daveslinux; Wed, 26 Mar 2014 23:46:34 -0700-]
[-calling local_scan(); timeout=300-]
[-local_scan() returned 0 NULL-]
[-Writing spool header file-]
[-Size of headers = 424-]
[-LOG: MAIN-]
[- <= <> R=1WT43z-00020Q-9d U=Debian-exim P=local S=1289-]
[-search_tidyup called-]
[-search_tidyup called-]
[->>>>>>>>>>>>>>>> Exim pid=7719 terminating with rc=0 >>>>>>>>>>>>>>>>-]
[-exec /usr/sbin/exim4 -d=0xfbb95cfd -Mc 1WT45C-00020V-Lq-]
[-Writing spool header file-]
[-Exim version 4.82 uid=107 gid=107 pid=7721 D=fbb95cfd-]
[-Berkeley DB: Berkeley DB 5.3.28: (September 9, 2013)-]
[-Support for: crypteq iconv() IPv6 GnuTLS move_frozen_messages DKIM-]
[-Lookups (built-in): lsearch wildlsearch nwildlsearch iplsearch cdb dbm dbmjz
dbmnz dnsdb dsearch nis nis0 passwd-]
[-Authenticators: cram_md5 plaintext-]
[-Routers: accept dnslookup ipliteral manualroute queryprogram redirect-]
[-Transports: appendfile/maildir/mailstore autoreply lmtp pipe smtp-]
[-Fixed never_users: 0-]
[-Size of off_t: 8-]
[-Compiler: GCC [4.8.2]-]
[-Library version: GnuTLS: Compile: 2.12.23-]
[- Runtime: 2.12.23-]
[-Library version: PCRE: Compile: 8.31-]
[- Runtime: 8.31 2012-07-06-]
[-Total 13 lookups-]
[-WHITELIST_D_MACROS: "OUTGOING"-]
[-TRUSTED_CONFIG_LIST: "/etc/exim4/trusted_configs"-]
[-changed uid/gid: forcing real = effective-]
[- uid=0 gid=107 pid=7721-]
[- auxiliary group list: <none>-]
[-seeking password data for user "uucp": cache not available-]
[-getpwnam() succeeded uid=10 gid=10-]
[-Size of headers = 314-]
[-LOG: MAIN-]
[- Completed-]
[-end delivery of 1WT43z-00020Q-9d-]
[-search_tidyup called-]
[-search_tidyup called-]
[->>>>>>>>>>>>>>>> Exim pid=7716 terminating with rc=0 >>>>>>>>>>>>>>>>-]
[-changed uid/gid: calling tls_validate_require_cipher-]
[- uid=107 gid=107 pid=7722-]
[- auxiliary group list: <none>-]
[-tls_validate_require_cipher child 7722 ended: status=0x0-]
[-configuration file is /var/lib/exim4/config.autogenerated-]
[-log selectors = 00000ffc 00632001-]
[-cwd=/var/spool/exim4 4 args: /usr/sbin/exim4 -d=0xfbb95cfd -Mc
1WT45C-00020V-Lq-]
[-trusted user-]
[-admin user-]
[-seeking password data for user "mail": cache not available-]
[-getpwnam() succeeded uid=8 gid=8-]
[-set_process_info: 7721 delivering specified messages-]
[-set_process_info: 7721 delivering 1WT45C-00020V-Lq-]
[-reading spool file 1WT45C-00020V-Lq-H-]
[-user=Debian-exim uid=107 gid=107 sender=-]
[-sender_local=0 ident=Debian-exim-]
[-Non-recipients:-]
[-Empty Tree-]
[----- End of tree -----]
[-recipients_count=1-]
[-body_linecount=23 message_linecount=10-]
[-Delivery address list:-]
[- dave@daveslinux -]
[-locking /var/spool/exim4/db/retry.lockfile-]
[-locked /var/spool/exim4/db/retry.lockfile-]
[-EXIM_DBOPEN(/var/spool/exim4/db/retry)-]
[-returned from EXIM_DBOPEN-]
[-no retry data available-]
[->>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>-]
[-Considering: dave@daveslinux-]
[-unique = dave@daveslinux-]
[-no domain retry record-]
[-no address retry record-]
[-dave@daveslinux: queued for routing-]
[->>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>-]
[-routing dave@daveslinux-]
[---------> hubbed_hosts router <---------]
[-local_part=dave domain=daveslinux-]
[-checking domains-]
[-expansion of "${if
exists{/etc/exim4/hubbed_hosts}{partial-lsearch;/etc/exim4/hubbed_hosts}fail}"
forced failure: assume not in this list-]
[-hubbed_hosts router skipped: domains mismatch-]
[---------> smarthost router <---------]
[-local_part=dave domain=daveslinux-]
[-checking domains-]
[-daveslinux in "@:localhost"? yes (matched "@")-]
[-daveslinux in "! +local_domains"? no (matched "! +local_domains")-]
[-smarthost router skipped: domains mismatch-]
[---------> real_local router <---------]
[-local_part=dave domain=daveslinux-]
[-real_local router skipped: prefix mismatch-]
[---------> system_aliases router <---------]
[-local_part=dave domain=daveslinux-]
[-checking domains-]
[-cached yes match for +local_domains-]
[-cached lookup data = NULL-]
[-daveslinux in "+local_domains"? yes (matched "+local_domains" - cached)-]
[-R: system_aliases for dave@daveslinux-]
[-calling system_aliases router-]
[-rda_interpret (string): ${lookup{$local_part}lsearch{/etc/aliases}}-]
[-search_open: lsearch "/etc/aliases"-]
[-search_find: file="/etc/aliases"-]
[- key="dave" partial=-1 affix=NULL starflags=0-]
[-LRU list:-]
[- 7/etc/aliases-]
[- End-]
[-internal_search_find: file="/etc/aliases"-]
[- type=lsearch key="dave"-]
[-file lookup required for dave-]
[- in /etc/aliases-]
[-lookup failed-]
[-expanded: -]
[-file is not a filter file-]
[-parse_forward_list: -]
[-system_aliases router declined for dave@daveslinux-]
[---------> userforward router <---------]
[-local_part=dave domain=daveslinux-]
[-checking domains-]
[-cached yes match for +local_domains-]
[-cached lookup data = NULL-]
[-daveslinux in "+local_domains"? yes (matched "+local_domains" - cached)-]
[-checking for local user-]
[-seeking password data for user "dave": cache not available-]
[-getpwnam() succeeded uid=1000 gid=1000-]
[-R: userforward for dave@daveslinux-]
[-checking require_files-]
[-seeking password data for user "dave": using cached result-]
[-getpwnam() succeeded uid=1000 gid=1000-]
[-check subsequent files for access by dave-]
[-file check: $home/.forward-]
[-expanded file: /home/dave/.forward-]
[-stat() yielded -1-]
[-errno = 2-]
[-userforward router skipped: file check-]
[---------> procmail router <---------]
[-local_part=dave domain=daveslinux-]
[-checking domains-]
[-cached yes match for +local_domains-]
[-cached lookup data = NULL-]
[-daveslinux in "+local_domains"? yes (matched "+local_domains" - cached)-]
[-checking for local user-]
[-seeking password data for user "dave": using cached result-]
[-getpwnam() succeeded uid=1000 gid=1000-]
[-R: procmail for dave@daveslinux-]
[-checking require_files-]
[-seeking password data for user "dave": using cached result-]
[-getpwnam() succeeded uid=1000 gid=1000-]
[-check subsequent files for access by dave-]
[-file check: ${if
exists{/etc/procmailrc}{/etc/procmailrc}{${home}/.procmailrc}}-]
[-expanded file: /home/dave/.procmailrc-]
[-stat() yielded -1-]
[-errno = 2-]
[-procmail router skipped: file check-]
[---------> maildrop router <---------]
[-local_part=dave domain=daveslinux-]
[-checking domains-]
[-cached yes match for +local_domains-]
[-cached lookup data = NULL-]
[-daveslinux in "+local_domains"? yes (matched "+local_domains" - cached)-]
[-checking for local user-]
[-seeking password data for user "dave": using cached result-]
[-getpwnam() succeeded uid=1000 gid=1000-]
[-R: maildrop for dave@daveslinux-]
[-checking require_files-]
[-seeking password data for user "dave": using cached result-]
[-getpwnam() succeeded uid=1000 gid=1000-]
[-check subsequent files for access by dave-]
[-file check: ${home}/.mailfilter-]
[-expanded file: /home/dave/.mailfilter-]
[-stat() yielded -1-]
[-errno = 2-]
[-maildrop router skipped: file check-]
[---------> lowuid_aliases router <---------]
[-local_part=dave domain=daveslinux-]
[-checking domains-]
[-cached yes match for +local_domains-]
[-cached lookup data = NULL-]
[-daveslinux in "+local_domains"? yes (matched "+local_domains" - cached)-]
[-checking for local user-]
[-seeking password data for user "dave": using cached result-]
[-getpwnam() succeeded uid=1000 gid=1000-]
[-R: lowuid_aliases for dave@daveslinux (UID 1000)-]
[-checking "condition"-]
[- in ":@[]"? yes (matched "")-]
[-lowuid_aliases router skipped: condition failure-]
[---------> local_user router <---------]
[-local_part=dave domain=daveslinux-]
[-checking domains-]
[-cached yes match for +local_domains-]
[-cached lookup data = NULL-]
[-daveslinux in "+local_domains"? yes (matched "+local_domains" - cached)-]
[-checking local_parts-]
[-dave in "! root"? yes (end of list)-]
[-checking for local user-]
[-seeking password data for user "dave": using cached result-]
[-getpwnam() succeeded uid=1000 gid=1000-]
[-R: local_user for dave@daveslinux-]
[-calling local_user router-]
[-local_user router called for dave@daveslinux-]
[- domain = daveslinux-]
[-set transport mail_spool-]
[-queued for mail_spool transport: local_part = dave-]
[-domain = daveslinux-]
[- errors_to=NULL-]
[- domain_data=NULL localpart_data=NULL-]
[-routed by local_user router-]
[- envelope to: dave@daveslinux-]
[- transport: mail_spool-]
[->>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>-]
[-After routing:-]
[- Local deliveries:-]
[- dave@daveslinux-]
[- Remote deliveries:-]
[- Failed addresses:-]
[- Deferred addresses:-]
[-search_tidyup called-]
[->>>>>>>>>>>>>>>> Local deliveries >>>>>>>>>>>>>>>>-]
[---------> dave@daveslinux <---------]
[-locking /var/spool/exim4/db/retry.lockfile-]
[-locked /var/spool/exim4/db/retry.lockfile-]
[-EXIM_DBOPEN(/var/spool/exim4/db/retry)-]
[-returned from EXIM_DBOPEN-]
[-no retry data available-]
[-search_tidyup called-]
[-changed uid/gid: local delivery to dave <dave@daveslinux>
transport=mail_spool-]
[- uid=1000 gid=8 pid=7723-]
[- auxiliary group list: <none>-]
[- home=/home/dave current=/home/dave-]
[-set_process_info: 7723 delivering 1WT45C-00020V-Lq to dave using mail_spool-]
[-T: appendfile for dave@daveslinux-]
[-appendfile transport entered-]
[-appendfile: mode=660 notify_comsat=0 quota=0 warning=0-]
[- file=/var/mail/dave format=unix-]
[- message_prefix=From ${if def:return_path{$return_path}{MAILER-DAEMON}}
${tod_bsdinbox}\n-]
[- message_suffix=\n-]
[- maildir_use_size_file=no-]
[- locking by lockfile fcntl -]
[-lock name: /var/mail/dave.lock-]
[-hitch name: /var/mail/dave.lock.daveslinux.5333c94b.00001e2b-]
[-lock file created-]
[-mailbox /var/mail/dave is locked-]
[-writing to file /var/mail/dave-]
[-writing data block fd=6 size=44 timeout=0-]
[-writing data block fd=6 size=1381 timeout=0-]
[-writing data block fd=6 size=1 timeout=0-]
[-appendfile yields 0 with errno=0 more_errno=0-]
[-journalling dave@daveslinux-]
[-search_tidyup called-]
[-mail_spool transport returned OK for dave@daveslinux-]
[-post-process dave@daveslinux (0)-]
[-dave@daveslinux delivered-]
[-LOG: MAIN-]
[- => dave <dave@daveslinux> R=local_user T=mail_spool-]
[->>>>>>>>>>>>>>>> deliveries are done >>>>>>>>>>>>>>>>-]
[-changed uid/gid: post-delivery tidying-]
[- uid=107 gid=107 pid=7721-]
[- auxiliary group list: <none>-]
[-set_process_info: 7721 tidying up after delivering 1WT45C-00020V-Lq-]
[-Processing retry items-]
[-Succeeded addresses:-]
[-dave@daveslinux: no retry items-]
Failed addresses:
Deferred addresses:
end of retry processing
LOG: MAIN
Completed
end delivery of [-1WT45C-00020V-Lq-] {+1WTGtR-0001K9-L7+}
search_tidyup called
search_tidyup called
>>>>>>>>>>>>>>>> Exim [-pid=7721-] {+pid=5095+} terminating with rc=0
>>>>>>>>>>>>>>>> >>>>>>>>>>>>>>>>
