Logging: dnssec status on accept & delivery lines
[users/jgh/exim.git] / test / stderr / 0408
1 Exim version x.yz ....
2 changed uid/gid: forcing real = effective
3   uid=uuuu gid=CALLER_GID pid=pppp
4 configuration file is TESTSUITE/test-config
5 admin user
6 changed uid/gid: privilege not needed
7   uid=EXIM_UID gid=EXIM_GID pid=pppp
8 DSN: r1 propagating DSN
9 seeking password data for user "CALLER": cache not available
10 getpwnam() succeeded uid=CALLER_UID gid=CALLER_GID
11 originator: uid=CALLER_UID gid=CALLER_GID login=CALLER name=CALLER_NAME
12 sender address = CALLER@test.ex
13 set_process_info: pppp accepting a local non-SMTP message from <CALLER@test.ex>
14 Sender: CALLER@test.ex
15 Recipients:
16   userx@test.ex
17 search_tidyup called
18 >>Headers received:
19
20 rewrite_one_header: type=F:
21   From: CALLER_NAME <CALLER@test.ex>
22 search_tidyup called
23 >>Headers after rewriting and local additions:
24 I Message-Id: <E10HmaX-0005vi-00@mail.test.ex>
25 F From: CALLER_NAME <CALLER@test.ex>
26   Date: Tue, 2 Mar 1999 09:44:33 +0000
27
28 Data file written for message 10HmaX-0005vi-00
29 >>Generated Received: header line
30 P Received: from CALLER by mail.test.ex with local (Exim x.yz)
31         (envelope-from <CALLER@test.ex>)
32         id 10HmaX-0005vi-00
33         for userx@test.ex; Tue, 2 Mar 1999 09:44:33 +0000
34 calling local_scan(); timeout=300
35 local_scan() returned 0 NULL
36 Writing spool header file
37 DSN: Write SPOOL :-dsn_envid NULL
38 DSN: Write SPOOL :-dsn_ret 0
39 DSN: Flags :0
40 DSN: **** SPOOL_OUT - address: |userx@test.ex| errorsto: |NULL| orcpt: |NULL| dsn_flags: 0
41 Size of headers = sss
42 LOG: MAIN
43   <= CALLER@test.ex U=CALLER P=local S=sss
44 created log directory TESTSUITE/spool/log
45 search_tidyup called
46 exec TESTSUITE/eximdir/exim -DEXIM_PATH=TESTSUITE/eximdir/exim -C TESTSUITE/test-config -d=0xfbb95cfd -odi -Mc 10HmaX-0005vi-00
47 Exim version x.yz ....
48 changed uid/gid: forcing real = effective
49   uid=uuuu gid=EXIM_GID pid=pppp
50 configuration file is TESTSUITE/test-config
51 trusted user
52 admin user
53 DSN: r1 propagating DSN
54 seeking password data for user "CALLER": cache not available
55 getpwnam() succeeded uid=CALLER_UID gid=CALLER_GID
56 set_process_info: pppp delivering specified messages
57 set_process_info: pppp delivering 10HmaX-0005vi-00
58 reading spool file 10HmaX-0005vi-00-H
59 user=CALLER uid=CALLER_UID gid=CALLER_GID sender=CALLER@test.ex
60 sender_local=1 ident=CALLER
61 Non-recipients:
62 Empty Tree
63 ---- End of tree ----
64 recipients_count=1
65 **** SPOOL_IN - No additional fields
66 body_linecount=0 message_linecount=7
67 DSN: set orcpt: NULL  flags: 0
68 Delivery address list:
69   userx@test.ex 
70 locking TESTSUITE/spool/db/retry.lockfile
71 locked TESTSUITE/spool/db/retry.lockfile
72 EXIM_DBOPEN(TESTSUITE/spool/db/retry)
73 returned from EXIM_DBOPEN
74 ensuring TESTSUITE/spool/db/retry.lockfile is owned by exim
75 no retry data available
76 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
77 Considering: userx@test.ex
78 unique = userx@test.ex
79 no domain retry record
80 no address retry record
81 userx@test.ex: queued for routing
82 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
83 routing userx@test.ex
84 --------> r1 router <--------
85 local_part=userx domain=test.ex
86 checking local_parts
87 userx in "userx : usery"? yes (matched "userx")
88 calling r1 router
89 r1 router called for userx@test.ex
90   domain = test.ex
91 ------ Verifying errors address usery ------
92 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
93 Verifying usery@test.ex
94 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
95 Considering usery@test.ex
96 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
97 routing usery@test.ex
98 --------> r1 router <--------
99 local_part=usery domain=test.ex
100 checking local_parts
101 usery in "userx : usery"? yes (matched "usery")
102 calling r1 router
103 r1 router called for usery@test.ex
104   domain = test.ex
105 skipped verify errors_to address: already verifying
106 set transport t1
107 queued for t1 transport: local_part = usery
108 domain = test.ex
109   errors_to=usery
110   domain_data=NULL localpart_data=NULL
111 routed by r1 router
112   envelope to: usery@test.ex
113   transport: t1
114   errors to usery
115 ------ End verifying errors address usery ------
116 queued for t1 transport: local_part = userx
117 domain = test.ex
118   errors_to=usery@test.ex
119   domain_data=NULL localpart_data=NULL
120 routed by r1 router
121   envelope to: userx@test.ex
122   transport: t1
123   errors to usery@test.ex
124 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
125 After routing:
126   Local deliveries:
127     userx@test.ex
128   Remote deliveries:
129   Failed addresses:
130   Deferred addresses:
131 search_tidyup called
132 >>>>>>>>>>>>>>>> Local deliveries >>>>>>>>>>>>>>>>
133 --------> userx@test.ex <--------
134 locking TESTSUITE/spool/db/retry.lockfile
135 locked TESTSUITE/spool/db/retry.lockfile
136 EXIM_DBOPEN(TESTSUITE/spool/db/retry)
137 returned from EXIM_DBOPEN
138 no retry data available
139 search_tidyup called
140 changed uid/gid: local delivery to userx <userx@test.ex> transport=t1
141   uid=CALLER_UID gid=CALLER_GID pid=pppp
142   home=NULL current=/
143 set_process_info: pppp delivering 10HmaX-0005vi-00 to userx using t1
144 appendfile transport entered
145 appendfile: mode=600 notify_comsat=0 quota=0 warning=0
146   file=TESTSUITE/test-mail/userx format=unix
147   message_prefix=From ${if def:return_path{$return_path}{MAILER-DAEMON}} ${tod_bsdinbox}\n
148   message_suffix=\n
149   maildir_use_size_file=no
150   locking by lockfile fcntl 
151 lock name: TESTSUITE/test-mail/userx.lock
152 hitch name: TESTSUITE/test-mail/userx.lock.test.ex.dddddddd.pppppppp
153 lock file created
154 mailbox TESTSUITE/test-mail/userx is locked
155 writing to file TESTSUITE/test-mail/userx
156 writing data block fd=dddd size=sss timeout=0
157 writing data block fd=dddd size=sss timeout=0
158 writing data block fd=dddd size=sss timeout=0
159 appendfile yields 0 with errno=dd more_errno=dd
160 search_tidyup called
161 journalling userx@test.ex
162 t1 transport returned OK for userx@test.ex
163 post-process userx@test.ex (0)
164 userx@test.ex delivered
165 LOG: MAIN
166   => userx <userx@test.ex> R=r1 T=t1
167 >>>>>>>>>>>>>>>> deliveries are done >>>>>>>>>>>>>>>>
168 changed uid/gid: post-delivery tidying
169   uid=EXIM_UID gid=EXIM_GID pid=pppp
170 set_process_info: pppp tidying up after delivering 10HmaX-0005vi-00
171 Processing retry items
172 Succeeded addresses:
173 userx@test.ex: no retry items
174 Failed addresses:
175 Deferred addresses:
176 end of retry processing
177 DSN: processing router : r1
178 DSN: processing successful delivery address: userx@test.ex
179 DSN: Sender_address: CALLER@test.ex
180 DSN: orcpt: NULL  flags: 0
181 DSN: envid: NULL  ret: 0
182 DSN: Final recipient: userx@test.ex
183 DSN: Remote SMTP server supports DSN: 0
184 DSN: not sending DSN success message
185 LOG: MAIN
186   Completed
187 end delivery of 10HmaX-0005vi-00
188 search_tidyup called
189 search_tidyup called
190 >>>>>>>>>>>>>>>> Exim pid=pppp terminating with rc=0 >>>>>>>>>>>>>>>>
191 search_tidyup called
192 >>>>>>>>>>>>>>>> Exim pid=pppp terminating with rc=0 >>>>>>>>>>>>>>>>