Fix 2-phase, in-order queue run delivery order
[exim.git] / test / stderr / 0183
1 Exim version x.yz ....
2 Hints DB:
3 changed uid/gid: forcing real = effective
4   uid=uuuu gid=CALLER_GID pid=p1234
5 configuration file is TESTSUITE/test-config
6 admin user
7 dropping to exim gid; retaining priv uid
8 originator: uid=CALLER_UID gid=CALLER_GID login=CALLER name=CALLER_NAME
9 sender address = CALLER@myhost.test.ex
10 Address testing: uid=uuuu gid=EXIM_GID euid=uuuu egid=EXIM_GID
11 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
12 Testing userx@test.again.dns
13 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
14 Considering userx@test.again.dns
15 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
16 routing userx@test.again.dns
17 --------> srv router <--------
18 local_part=userx domain=test.again.dns
19 checking local_parts
20 userx in local_parts?
21  list element: ^srv
22  compiled caseless RE '^srv' not found in local cache
23  compiled RE '^srv' saved in local cache
24 userx in local_parts? no (end of list)
25 srv router skipped: local_parts mismatch
26 --------> useryz router <--------
27 local_part=userx domain=test.again.dns
28 checking local_parts
29 userx in local_parts?
30  list element: usery
31  list element: userz
32 userx in local_parts? no (end of list)
33 useryz router skipped: local_parts mismatch
34 --------> lookuphost router <--------
35 local_part=userx domain=test.again.dns
36 checking local_parts
37 userx in local_parts?
38  list element: !userd
39 userx in local_parts? yes (end of list)
40 calling lookuphost router
41 lookuphost router called for userx@test.again.dns
42   domain = test.again.dns
43 main lookup for domain
44  check dnssec require list
45   test.again.dns in dnssec_require_domains? no (option unset)
46  check dnssec request list
47   test.again.dns in dnssec_request_domains?
48    list element: *
49    test.again.dns in dnssec_request_domains? yes (matched "*")
50  DNS lookup of test.again.dns (MX) using fakens
51  DNS lookup of test.again.dns (MX) gave TRY_AGAIN
52  test.again.dns in dns_again_means_nonexist? no (option unset)
53  returning DNS_AGAIN
54   writing neg-cache entry for test.again.dns-MX-xxxx, ttl -1
55  test.again.dns not in empty list (option unset? cannot trace name)
56 lookuphost router: defer for userx@test.again.dns
57   message: host lookup did not complete
58 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
59 Testing abcd@test.again.dns
60 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
61 Considering abcd@test.again.dns
62 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
63 routing abcd@test.again.dns
64 --------> srv router <--------
65 local_part=abcd domain=test.again.dns
66 checking local_parts
67 abcd in local_parts?
68  list element: ^srv
69  compiled caseless RE '^srv' found in local cache
70 abcd in local_parts? no (end of list)
71 srv router skipped: local_parts mismatch
72 --------> useryz router <--------
73 local_part=abcd domain=test.again.dns
74 checking local_parts
75 abcd in local_parts?
76  list element: usery
77  list element: userz
78 abcd in local_parts? no (end of list)
79 useryz router skipped: local_parts mismatch
80 --------> lookuphost router <--------
81 local_part=abcd domain=test.again.dns
82 checking local_parts
83 abcd in local_parts?
84  list element: !userd
85 abcd in local_parts? yes (end of list)
86 calling lookuphost router
87 lookuphost router called for abcd@test.again.dns
88   domain = test.again.dns
89 main lookup for domain
90  check dnssec require list
91   test.again.dns in dnssec_require_domains? no (option unset)
92  check dnssec request list
93   test.again.dns in dnssec_request_domains?
94    list element: *
95    test.again.dns in dnssec_request_domains? yes (matched "*")
96  DNS lookup of test.again.dns (MX): using cached value DNS_AGAIN
97  test.again.dns not in empty list (option unset? cannot trace name)
98 lookuphost router: defer for abcd@test.again.dns
99   message: host lookup did not complete
100 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
101 Testing abcd@ten-1.test.ex
102 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
103 Considering abcd@ten-1.test.ex
104 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
105 routing abcd@ten-1.test.ex
106 --------> srv router <--------
107 local_part=abcd domain=ten-1.test.ex
108 checking local_parts
109 abcd in local_parts?
110  list element: ^srv
111  compiled caseless RE '^srv' found in local cache
112 abcd in local_parts? no (end of list)
113 srv router skipped: local_parts mismatch
114 --------> useryz router <--------
115 local_part=abcd domain=ten-1.test.ex
116 checking local_parts
117 abcd in local_parts?
118  list element: usery
119  list element: userz
120 abcd in local_parts? no (end of list)
121 useryz router skipped: local_parts mismatch
122 --------> lookuphost router <--------
123 local_part=abcd domain=ten-1.test.ex
124 checking local_parts
125 abcd in local_parts?
126  list element: !userd
127 abcd in local_parts? yes (end of list)
128 calling lookuphost router
129 lookuphost router called for abcd@ten-1.test.ex
130   domain = ten-1.test.ex
131 main lookup for domain
132  check dnssec require list
133   ten-1.test.ex in dnssec_require_domains? no (option unset)
134  check dnssec request list
135   ten-1.test.ex in dnssec_request_domains?
136    list element: *
137    ten-1.test.ex in dnssec_request_domains? yes (matched "*")
138  DNS lookup of ten-1.test.ex (MX) using fakens
139  DNS lookup of ten-1.test.ex (MX) gave NO_DATA
140  returning DNS_NODATA
141  faking res_search(MX) response length as 65535
142   writing neg-cache entry for ten-1.test.ex-MX-xxxx, ttl 3000
143  ten-1.test.ex (MX resp) DNSSEC
144  DNS lookup of ten-1.test.ex (A) using fakens
145  DNS lookup of ten-1.test.ex (A) succeeded
146  fully qualified name = ten-1.test.ex
147  ten-1.test.ex V4NET.0.0.1 mx=-1 sort=xx 
148 set transport smtp
149 queued for smtp transport: local_part = abcd
150 domain = ten-1.test.ex
151   errors_to=NULL
152   domain_data=NULL local_part_data=NULL
153 routed by lookuphost router
154   envelope to: abcd@ten-1.test.ex
155   transport: smtp
156   host ten-1.test.ex [V4NET.0.0.1]
157 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
158 Testing usery@test.again.dns
159 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
160 Considering usery@test.again.dns
161 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
162 routing usery@test.again.dns
163 --------> srv router <--------
164 local_part=usery domain=test.again.dns
165 checking local_parts
166 usery in local_parts?
167  list element: ^srv
168  compiled caseless RE '^srv' found in local cache
169 usery in local_parts? no (end of list)
170 srv router skipped: local_parts mismatch
171 --------> useryz router <--------
172 local_part=usery domain=test.again.dns
173 checking local_parts
174 usery in local_parts?
175  list element: usery
176  usery in local_parts? yes (matched "usery")
177 calling useryz router
178 useryz router called for usery@test.again.dns
179   domain = test.again.dns
180 route_item = * $domain bydns
181 test.again.dns in "*"?
182  list element: *
183  test.again.dns in "*"? yes (matched "*")
184 original list of hosts = '$domain' options = 'bydns'
185 expanded list of hosts = 'test.again.dns' options = 'bydns'
186 set transport smtp
187 finding IP address for test.again.dns
188 doing DNS lookup
189 check dnssec require list
190  test.again.dns in dnssec_require_domains? no (option unset)
191 check dnssec request list
192  test.again.dns in dnssec_request_domains?
193   list element: *
194   test.again.dns in dnssec_request_domains? yes (matched "*")
195 DNS lookup of test.again.dns (A) using fakens
196 DNS lookup of test.again.dns (A) gave TRY_AGAIN
197 test.again.dns in dns_again_means_nonexist? no (option unset)
198 returning DNS_AGAIN
199  writing neg-cache entry for test.again.dns-A-xxxx, ttl -1
200 useryz router: defer for usery@test.again.dns
201   message: host lookup for test.again.dns did not complete (DNS timeout?)
202 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
203 Testing userz@test.again.dns
204 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
205 Considering userz@test.again.dns
206 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
207 routing userz@test.again.dns
208 --------> srv router <--------
209 local_part=userz domain=test.again.dns
210 checking local_parts
211 userz in local_parts?
212  list element: ^srv
213  compiled caseless RE '^srv' found in local cache
214 userz in local_parts? no (end of list)
215 srv router skipped: local_parts mismatch
216 --------> useryz router <--------
217 local_part=userz domain=test.again.dns
218 checking local_parts
219 userz in local_parts?
220  list element: usery
221  list element: userz
222  userz in local_parts? yes (matched "userz")
223 calling useryz router
224 useryz router called for userz@test.again.dns
225   domain = test.again.dns
226 route_item = * $domain bydns
227 test.again.dns in "*"?
228  list element: *
229  test.again.dns in "*"? yes (matched "*")
230 original list of hosts = '$domain' options = 'bydns'
231 expanded list of hosts = 'test.again.dns' options = 'bydns'
232 finding IP address for test.again.dns
233 doing DNS lookup
234 check dnssec require list
235  test.again.dns in dnssec_require_domains? no (option unset)
236 check dnssec request list
237  test.again.dns in dnssec_request_domains?
238   list element: *
239   test.again.dns in dnssec_request_domains? yes (matched "*")
240 DNS lookup of test.again.dns (A): using cached value DNS_AGAIN
241 useryz router: defer for userz@test.again.dns
242   message: host lookup for test.again.dns did not complete (DNS timeout?)
243 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
244 Testing xyz@ten-1.test.ex
245 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
246 Considering xyz@ten-1.test.ex
247 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
248 routing xyz@ten-1.test.ex
249 --------> srv router <--------
250 local_part=xyz domain=ten-1.test.ex
251 checking local_parts
252 xyz in local_parts?
253  list element: ^srv
254  compiled caseless RE '^srv' found in local cache
255 xyz in local_parts? no (end of list)
256 srv router skipped: local_parts mismatch
257 --------> useryz router <--------
258 local_part=xyz domain=ten-1.test.ex
259 checking local_parts
260 xyz in local_parts?
261  list element: usery
262  list element: userz
263 xyz in local_parts? no (end of list)
264 useryz router skipped: local_parts mismatch
265 --------> lookuphost router <--------
266 local_part=xyz domain=ten-1.test.ex
267 checking local_parts
268 xyz in local_parts?
269  list element: !userd
270 xyz in local_parts? yes (end of list)
271 calling lookuphost router
272 lookuphost router called for xyz@ten-1.test.ex
273   domain = ten-1.test.ex
274 main lookup for domain
275  check dnssec require list
276   ten-1.test.ex in dnssec_require_domains? no (option unset)
277  check dnssec request list
278   ten-1.test.ex in dnssec_request_domains?
279    list element: *
280    ten-1.test.ex in dnssec_request_domains? yes (matched "*")
281  DNS lookup of ten-1.test.ex (MX): using cached value DNS_NODATA
282  DNS lookup of ten-1.test.ex (A) using fakens
283  DNS lookup of ten-1.test.ex (A) succeeded
284  fully qualified name = ten-1.test.ex
285  ten-1.test.ex V4NET.0.0.1 mx=-1 sort=xx 
286 queued for smtp transport: local_part = xyz
287 domain = ten-1.test.ex
288   errors_to=NULL
289   domain_data=NULL local_part_data=NULL
290 routed by lookuphost router
291   envelope to: xyz@ten-1.test.ex
292   transport: smtp
293   host ten-1.test.ex [V4NET.0.0.1]
294 search_tidyup called
295 >>>>>>>>>>>>>>>> Exim pid=p1234 (fresh-exec) terminating with rc=1 >>>>>>>>>>>>>>>>
296 Exim version x.yz ....
297 Hints DB:
298 changed uid/gid: forcing real = effective
299   uid=uuuu gid=CALLER_GID pid=p1235
300 configuration file is TESTSUITE/test-config
301 admin user
302 dropping to exim gid; retaining priv uid
303 originator: uid=CALLER_UID gid=CALLER_GID login=CALLER name=CALLER_NAME
304 sender address = CALLER@myhost.test.ex
305 Address testing: uid=uuuu gid=EXIM_GID euid=uuuu egid=EXIM_GID
306 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
307 Testing userx@test.fail.dns
308 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
309 Considering userx@test.fail.dns
310 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
311 routing userx@test.fail.dns
312 --------> srv router <--------
313 local_part=userx domain=test.fail.dns
314 checking local_parts
315 userx in local_parts?
316  list element: ^srv
317  compiled caseless RE '^srv' not found in local cache
318  compiled RE '^srv' saved in local cache
319 userx in local_parts? no (end of list)
320 srv router skipped: local_parts mismatch
321 --------> useryz router <--------
322 local_part=userx domain=test.fail.dns
323 checking local_parts
324 userx in local_parts?
325  list element: usery
326  list element: userz
327 userx in local_parts? no (end of list)
328 useryz router skipped: local_parts mismatch
329 --------> lookuphost router <--------
330 local_part=userx domain=test.fail.dns
331 checking local_parts
332 userx in local_parts?
333  list element: !userd
334 userx in local_parts? yes (end of list)
335 calling lookuphost router
336 lookuphost router called for userx@test.fail.dns
337   domain = test.fail.dns
338 main lookup for domain
339  check dnssec require list
340   test.fail.dns in dnssec_require_domains? no (option unset)
341  check dnssec request list
342   test.fail.dns in dnssec_request_domains?
343    list element: *
344    test.fail.dns in dnssec_request_domains? yes (matched "*")
345  DNS lookup of test.fail.dns (MX) using fakens
346  DNS lookup of test.fail.dns (MX) gave NO_RECOVERY
347  returning DNS_FAIL
348   writing neg-cache entry for test.fail.dns-MX-xxxx, ttl -1
349  test.fail.dns not in empty list (option unset? cannot trace name)
350 lookuphost router: defer for userx@test.fail.dns
351   message: host lookup did not complete
352 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
353 Testing abcd@test.fail.dns
354 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
355 Considering abcd@test.fail.dns
356 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
357 routing abcd@test.fail.dns
358 --------> srv router <--------
359 local_part=abcd domain=test.fail.dns
360 checking local_parts
361 abcd in local_parts?
362  list element: ^srv
363  compiled caseless RE '^srv' found in local cache
364 abcd in local_parts? no (end of list)
365 srv router skipped: local_parts mismatch
366 --------> useryz router <--------
367 local_part=abcd domain=test.fail.dns
368 checking local_parts
369 abcd in local_parts?
370  list element: usery
371  list element: userz
372 abcd in local_parts? no (end of list)
373 useryz router skipped: local_parts mismatch
374 --------> lookuphost router <--------
375 local_part=abcd domain=test.fail.dns
376 checking local_parts
377 abcd in local_parts?
378  list element: !userd
379 abcd in local_parts? yes (end of list)
380 calling lookuphost router
381 lookuphost router called for abcd@test.fail.dns
382   domain = test.fail.dns
383 main lookup for domain
384  check dnssec require list
385   test.fail.dns in dnssec_require_domains? no (option unset)
386  check dnssec request list
387   test.fail.dns in dnssec_request_domains?
388    list element: *
389    test.fail.dns in dnssec_request_domains? yes (matched "*")
390  DNS lookup of test.fail.dns (MX): using cached value DNS_FAIL
391  test.fail.dns not in empty list (option unset? cannot trace name)
392 lookuphost router: defer for abcd@test.fail.dns
393   message: host lookup did not complete
394 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
395 Testing abcd@ten-1.test.ex
396 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
397 Considering abcd@ten-1.test.ex
398 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
399 routing abcd@ten-1.test.ex
400 --------> srv router <--------
401 local_part=abcd domain=ten-1.test.ex
402 checking local_parts
403 abcd in local_parts?
404  list element: ^srv
405  compiled caseless RE '^srv' found in local cache
406 abcd in local_parts? no (end of list)
407 srv router skipped: local_parts mismatch
408 --------> useryz router <--------
409 local_part=abcd domain=ten-1.test.ex
410 checking local_parts
411 abcd in local_parts?
412  list element: usery
413  list element: userz
414 abcd in local_parts? no (end of list)
415 useryz router skipped: local_parts mismatch
416 --------> lookuphost router <--------
417 local_part=abcd domain=ten-1.test.ex
418 checking local_parts
419 abcd in local_parts?
420  list element: !userd
421 abcd in local_parts? yes (end of list)
422 calling lookuphost router
423 lookuphost router called for abcd@ten-1.test.ex
424   domain = ten-1.test.ex
425 main lookup for domain
426  check dnssec require list
427   ten-1.test.ex in dnssec_require_domains? no (option unset)
428  check dnssec request list
429   ten-1.test.ex in dnssec_request_domains?
430    list element: *
431    ten-1.test.ex in dnssec_request_domains? yes (matched "*")
432  DNS lookup of ten-1.test.ex (MX) using fakens
433  DNS lookup of ten-1.test.ex (MX) gave NO_DATA
434  returning DNS_NODATA
435  faking res_search(MX) response length as 65535
436   writing neg-cache entry for ten-1.test.ex-MX-xxxx, ttl 3000
437  ten-1.test.ex (MX resp) DNSSEC
438  DNS lookup of ten-1.test.ex (A) using fakens
439  DNS lookup of ten-1.test.ex (A) succeeded
440  fully qualified name = ten-1.test.ex
441  ten-1.test.ex V4NET.0.0.1 mx=-1 sort=xx 
442 set transport smtp
443 queued for smtp transport: local_part = abcd
444 domain = ten-1.test.ex
445   errors_to=NULL
446   domain_data=NULL local_part_data=NULL
447 routed by lookuphost router
448   envelope to: abcd@ten-1.test.ex
449   transport: smtp
450   host ten-1.test.ex [V4NET.0.0.1]
451 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
452 Testing usery@test.fail.dns
453 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
454 Considering usery@test.fail.dns
455 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
456 routing usery@test.fail.dns
457 --------> srv router <--------
458 local_part=usery domain=test.fail.dns
459 checking local_parts
460 usery in local_parts?
461  list element: ^srv
462  compiled caseless RE '^srv' found in local cache
463 usery in local_parts? no (end of list)
464 srv router skipped: local_parts mismatch
465 --------> useryz router <--------
466 local_part=usery domain=test.fail.dns
467 checking local_parts
468 usery in local_parts?
469  list element: usery
470  usery in local_parts? yes (matched "usery")
471 calling useryz router
472 useryz router called for usery@test.fail.dns
473   domain = test.fail.dns
474 route_item = * $domain bydns
475 test.fail.dns in "*"?
476  list element: *
477  test.fail.dns in "*"? yes (matched "*")
478 original list of hosts = '$domain' options = 'bydns'
479 expanded list of hosts = 'test.fail.dns' options = 'bydns'
480 set transport smtp
481 finding IP address for test.fail.dns
482 doing DNS lookup
483 check dnssec require list
484  test.fail.dns in dnssec_require_domains? no (option unset)
485 check dnssec request list
486  test.fail.dns in dnssec_request_domains?
487   list element: *
488   test.fail.dns in dnssec_request_domains? yes (matched "*")
489 DNS lookup of test.fail.dns (A) using fakens
490 DNS lookup of test.fail.dns (A) gave NO_RECOVERY
491 returning DNS_FAIL
492  writing neg-cache entry for test.fail.dns-A-xxxx, ttl -1
493 useryz router: defer for usery@test.fail.dns
494   message: host lookup for test.fail.dns did not complete (DNS timeout?)
495 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
496 Testing userz@test.fail.dns
497 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
498 Considering userz@test.fail.dns
499 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
500 routing userz@test.fail.dns
501 --------> srv router <--------
502 local_part=userz domain=test.fail.dns
503 checking local_parts
504 userz in local_parts?
505  list element: ^srv
506  compiled caseless RE '^srv' found in local cache
507 userz in local_parts? no (end of list)
508 srv router skipped: local_parts mismatch
509 --------> useryz router <--------
510 local_part=userz domain=test.fail.dns
511 checking local_parts
512 userz in local_parts?
513  list element: usery
514  list element: userz
515  userz in local_parts? yes (matched "userz")
516 calling useryz router
517 useryz router called for userz@test.fail.dns
518   domain = test.fail.dns
519 route_item = * $domain bydns
520 test.fail.dns in "*"?
521  list element: *
522  test.fail.dns in "*"? yes (matched "*")
523 original list of hosts = '$domain' options = 'bydns'
524 expanded list of hosts = 'test.fail.dns' options = 'bydns'
525 finding IP address for test.fail.dns
526 doing DNS lookup
527 check dnssec require list
528  test.fail.dns in dnssec_require_domains? no (option unset)
529 check dnssec request list
530  test.fail.dns in dnssec_request_domains?
531   list element: *
532   test.fail.dns in dnssec_request_domains? yes (matched "*")
533 DNS lookup of test.fail.dns (A): using cached value DNS_FAIL
534 useryz router: defer for userz@test.fail.dns
535   message: host lookup for test.fail.dns did not complete (DNS timeout?)
536 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
537 Testing xyz@ten-1.test.ex
538 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
539 Considering xyz@ten-1.test.ex
540 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
541 routing xyz@ten-1.test.ex
542 --------> srv router <--------
543 local_part=xyz domain=ten-1.test.ex
544 checking local_parts
545 xyz in local_parts?
546  list element: ^srv
547  compiled caseless RE '^srv' found in local cache
548 xyz in local_parts? no (end of list)
549 srv router skipped: local_parts mismatch
550 --------> useryz router <--------
551 local_part=xyz domain=ten-1.test.ex
552 checking local_parts
553 xyz in local_parts?
554  list element: usery
555  list element: userz
556 xyz in local_parts? no (end of list)
557 useryz router skipped: local_parts mismatch
558 --------> lookuphost router <--------
559 local_part=xyz domain=ten-1.test.ex
560 checking local_parts
561 xyz in local_parts?
562  list element: !userd
563 xyz in local_parts? yes (end of list)
564 calling lookuphost router
565 lookuphost router called for xyz@ten-1.test.ex
566   domain = ten-1.test.ex
567 main lookup for domain
568  check dnssec require list
569   ten-1.test.ex in dnssec_require_domains? no (option unset)
570  check dnssec request list
571   ten-1.test.ex in dnssec_request_domains?
572    list element: *
573    ten-1.test.ex in dnssec_request_domains? yes (matched "*")
574  DNS lookup of ten-1.test.ex (MX): using cached value DNS_NODATA
575  DNS lookup of ten-1.test.ex (A) using fakens
576  DNS lookup of ten-1.test.ex (A) succeeded
577  fully qualified name = ten-1.test.ex
578  ten-1.test.ex V4NET.0.0.1 mx=-1 sort=xx 
579 queued for smtp transport: local_part = xyz
580 domain = ten-1.test.ex
581   errors_to=NULL
582   domain_data=NULL local_part_data=NULL
583 routed by lookuphost router
584   envelope to: xyz@ten-1.test.ex
585   transport: smtp
586   host ten-1.test.ex [V4NET.0.0.1]
587 search_tidyup called
588 >>>>>>>>>>>>>>>> Exim pid=p1235 (fresh-exec) terminating with rc=1 >>>>>>>>>>>>>>>>
589 Exim version x.yz ....
590 Hints DB:
591 changed uid/gid: forcing real = effective
592   uid=uuuu gid=CALLER_GID pid=p1236
593 configuration file is TESTSUITE/test-config
594 admin user
595 dropping to exim gid; retaining priv uid
596 originator: uid=CALLER_UID gid=CALLER_GID login=CALLER name=CALLER_NAME
597 sender address = CALLER@myhost.test.ex
598 Address testing: uid=uuuu gid=EXIM_GID euid=uuuu egid=EXIM_GID
599 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
600 Testing userx@nonexist.test.ex
601 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
602 Considering userx@nonexist.test.ex
603 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
604 routing userx@nonexist.test.ex
605 --------> srv router <--------
606 local_part=userx domain=nonexist.test.ex
607 checking local_parts
608 userx in local_parts?
609  list element: ^srv
610  compiled caseless RE '^srv' not found in local cache
611  compiled RE '^srv' saved in local cache
612 userx in local_parts? no (end of list)
613 srv router skipped: local_parts mismatch
614 --------> useryz router <--------
615 local_part=userx domain=nonexist.test.ex
616 checking local_parts
617 userx in local_parts?
618  list element: usery
619  list element: userz
620 userx in local_parts? no (end of list)
621 useryz router skipped: local_parts mismatch
622 --------> lookuphost router <--------
623 local_part=userx domain=nonexist.test.ex
624 checking local_parts
625 userx in local_parts?
626  list element: !userd
627 userx in local_parts? yes (end of list)
628 calling lookuphost router
629 lookuphost router called for userx@nonexist.test.ex
630   domain = nonexist.test.ex
631 main lookup for domain
632  check dnssec require list
633   nonexist.test.ex in dnssec_require_domains? no (option unset)
634  check dnssec request list
635   nonexist.test.ex in dnssec_request_domains?
636    list element: *
637    nonexist.test.ex in dnssec_request_domains? yes (matched "*")
638  DNS lookup of nonexist.test.ex (MX) using fakens
639  DNS lookup of nonexist.test.ex (MX) gave HOST_NOT_FOUND
640  returning DNS_NOMATCH
641  faking res_search(MX) response length as 65535
642   writing neg-cache entry for nonexist.test.ex-MX-xxxx, ttl 3000
643 lookuphost router declined for userx@nonexist.test.ex
644 "more" is false: skipping remaining routers
645 no more routers
646 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
647 Testing abcd@nonexist.test.ex
648 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
649 Considering abcd@nonexist.test.ex
650 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
651 routing abcd@nonexist.test.ex
652 --------> srv router <--------
653 local_part=abcd domain=nonexist.test.ex
654 checking local_parts
655 abcd in local_parts?
656  list element: ^srv
657  compiled caseless RE '^srv' found in local cache
658 abcd in local_parts? no (end of list)
659 srv router skipped: local_parts mismatch
660 --------> useryz router <--------
661 local_part=abcd domain=nonexist.test.ex
662 checking local_parts
663 abcd in local_parts?
664  list element: usery
665  list element: userz
666 abcd in local_parts? no (end of list)
667 useryz router skipped: local_parts mismatch
668 --------> lookuphost router <--------
669 local_part=abcd domain=nonexist.test.ex
670 checking local_parts
671 abcd in local_parts?
672  list element: !userd
673 abcd in local_parts? yes (end of list)
674 calling lookuphost router
675 lookuphost router called for abcd@nonexist.test.ex
676   domain = nonexist.test.ex
677 main lookup for domain
678  check dnssec require list
679   nonexist.test.ex in dnssec_require_domains? no (option unset)
680  check dnssec request list
681   nonexist.test.ex in dnssec_request_domains?
682    list element: *
683    nonexist.test.ex in dnssec_request_domains? yes (matched "*")
684  DNS lookup of nonexist.test.ex (MX): using cached value DNS_NOMATCH
685 lookuphost router declined for abcd@nonexist.test.ex
686 "more" is false: skipping remaining routers
687 no more routers
688 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
689 Testing abcd@ten-1.test.ex
690 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
691 Considering abcd@ten-1.test.ex
692 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
693 routing abcd@ten-1.test.ex
694 --------> srv router <--------
695 local_part=abcd domain=ten-1.test.ex
696 checking local_parts
697 abcd in local_parts?
698  list element: ^srv
699  compiled caseless RE '^srv' found in local cache
700 abcd in local_parts? no (end of list)
701 srv router skipped: local_parts mismatch
702 --------> useryz router <--------
703 local_part=abcd domain=ten-1.test.ex
704 checking local_parts
705 abcd in local_parts?
706  list element: usery
707  list element: userz
708 abcd in local_parts? no (end of list)
709 useryz router skipped: local_parts mismatch
710 --------> lookuphost router <--------
711 local_part=abcd domain=ten-1.test.ex
712 checking local_parts
713 abcd in local_parts?
714  list element: !userd
715 abcd in local_parts? yes (end of list)
716 calling lookuphost router
717 lookuphost router called for abcd@ten-1.test.ex
718   domain = ten-1.test.ex
719 main lookup for domain
720  check dnssec require list
721   ten-1.test.ex in dnssec_require_domains? no (option unset)
722  check dnssec request list
723   ten-1.test.ex in dnssec_request_domains?
724    list element: *
725    ten-1.test.ex in dnssec_request_domains? yes (matched "*")
726  DNS lookup of ten-1.test.ex (MX) using fakens
727  DNS lookup of ten-1.test.ex (MX) gave NO_DATA
728  returning DNS_NODATA
729  faking res_search(MX) response length as 65535
730   writing neg-cache entry for ten-1.test.ex-MX-xxxx, ttl 3000
731  ten-1.test.ex (MX resp) DNSSEC
732  DNS lookup of ten-1.test.ex (A) using fakens
733  DNS lookup of ten-1.test.ex (A) succeeded
734  fully qualified name = ten-1.test.ex
735  ten-1.test.ex V4NET.0.0.1 mx=-1 sort=xx 
736 set transport smtp
737 queued for smtp transport: local_part = abcd
738 domain = ten-1.test.ex
739   errors_to=NULL
740   domain_data=NULL local_part_data=NULL
741 routed by lookuphost router
742   envelope to: abcd@ten-1.test.ex
743   transport: smtp
744   host ten-1.test.ex [V4NET.0.0.1]
745 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
746 Testing usery@nonexist.test.ex
747 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
748 Considering usery@nonexist.test.ex
749 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
750 routing usery@nonexist.test.ex
751 --------> srv router <--------
752 local_part=usery domain=nonexist.test.ex
753 checking local_parts
754 usery in local_parts?
755  list element: ^srv
756  compiled caseless RE '^srv' found in local cache
757 usery in local_parts? no (end of list)
758 srv router skipped: local_parts mismatch
759 --------> useryz router <--------
760 local_part=usery domain=nonexist.test.ex
761 checking local_parts
762 usery in local_parts?
763  list element: usery
764  usery in local_parts? yes (matched "usery")
765 calling useryz router
766 useryz router called for usery@nonexist.test.ex
767   domain = nonexist.test.ex
768 route_item = * $domain bydns
769 nonexist.test.ex in "*"?
770  list element: *
771  nonexist.test.ex in "*"? yes (matched "*")
772 original list of hosts = '$domain' options = 'bydns'
773 expanded list of hosts = 'nonexist.test.ex' options = 'bydns'
774 set transport smtp
775 finding IP address for nonexist.test.ex
776 doing DNS lookup
777 check dnssec require list
778  nonexist.test.ex in dnssec_require_domains? no (option unset)
779 check dnssec request list
780  nonexist.test.ex in dnssec_request_domains?
781   list element: *
782   nonexist.test.ex in dnssec_request_domains? yes (matched "*")
783 DNS lookup of nonexist.test.ex (A) using fakens
784 DNS lookup of nonexist.test.ex (A) gave HOST_NOT_FOUND
785 returning DNS_NOMATCH
786 faking res_search(A) response length as 65535
787  writing neg-cache entry for nonexist.test.ex-A-xxxx, ttl 3000
788 useryz router: defer for usery@nonexist.test.ex
789   message: lookup of host "nonexist.test.ex" failed in useryz router
790 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
791 Testing userz@nonexist.test.ex
792 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
793 Considering userz@nonexist.test.ex
794 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
795 routing userz@nonexist.test.ex
796 --------> srv router <--------
797 local_part=userz domain=nonexist.test.ex
798 checking local_parts
799 userz in local_parts?
800  list element: ^srv
801  compiled caseless RE '^srv' found in local cache
802 userz in local_parts? no (end of list)
803 srv router skipped: local_parts mismatch
804 --------> useryz router <--------
805 local_part=userz domain=nonexist.test.ex
806 checking local_parts
807 userz in local_parts?
808  list element: usery
809  list element: userz
810  userz in local_parts? yes (matched "userz")
811 calling useryz router
812 useryz router called for userz@nonexist.test.ex
813   domain = nonexist.test.ex
814 route_item = * $domain bydns
815 nonexist.test.ex in "*"?
816  list element: *
817  nonexist.test.ex in "*"? yes (matched "*")
818 original list of hosts = '$domain' options = 'bydns'
819 expanded list of hosts = 'nonexist.test.ex' options = 'bydns'
820 finding IP address for nonexist.test.ex
821 doing DNS lookup
822 check dnssec require list
823  nonexist.test.ex in dnssec_require_domains? no (option unset)
824 check dnssec request list
825  nonexist.test.ex in dnssec_request_domains?
826   list element: *
827   nonexist.test.ex in dnssec_request_domains? yes (matched "*")
828 DNS lookup of nonexist.test.ex (A): using cached value DNS_NOMATCH
829 useryz router: defer for userz@nonexist.test.ex
830   message: lookup of host "nonexist.test.ex" failed in useryz router
831 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
832 Testing xyz@ten-1.test.ex
833 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
834 Considering xyz@ten-1.test.ex
835 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
836 routing xyz@ten-1.test.ex
837 --------> srv router <--------
838 local_part=xyz domain=ten-1.test.ex
839 checking local_parts
840 xyz in local_parts?
841  list element: ^srv
842  compiled caseless RE '^srv' found in local cache
843 xyz in local_parts? no (end of list)
844 srv router skipped: local_parts mismatch
845 --------> useryz router <--------
846 local_part=xyz domain=ten-1.test.ex
847 checking local_parts
848 xyz in local_parts?
849  list element: usery
850  list element: userz
851 xyz in local_parts? no (end of list)
852 useryz router skipped: local_parts mismatch
853 --------> lookuphost router <--------
854 local_part=xyz domain=ten-1.test.ex
855 checking local_parts
856 xyz in local_parts?
857  list element: !userd
858 xyz in local_parts? yes (end of list)
859 calling lookuphost router
860 lookuphost router called for xyz@ten-1.test.ex
861   domain = ten-1.test.ex
862 main lookup for domain
863  check dnssec require list
864   ten-1.test.ex in dnssec_require_domains? no (option unset)
865  check dnssec request list
866   ten-1.test.ex in dnssec_request_domains?
867    list element: *
868    ten-1.test.ex in dnssec_request_domains? yes (matched "*")
869  DNS lookup of ten-1.test.ex (MX): using cached value DNS_NODATA
870  DNS lookup of ten-1.test.ex (A) using fakens
871  DNS lookup of ten-1.test.ex (A) succeeded
872  fully qualified name = ten-1.test.ex
873  ten-1.test.ex V4NET.0.0.1 mx=-1 sort=xx 
874 queued for smtp transport: local_part = xyz
875 domain = ten-1.test.ex
876   errors_to=NULL
877   domain_data=NULL local_part_data=NULL
878 routed by lookuphost router
879   envelope to: xyz@ten-1.test.ex
880   transport: smtp
881   host ten-1.test.ex [V4NET.0.0.1]
882 search_tidyup called
883 >>>>>>>>>>>>>>>> Exim pid=p1236 (fresh-exec) terminating with rc=2 >>>>>>>>>>>>>>>>
884 Exim version x.yz ....
885 Hints DB:
886 changed uid/gid: forcing real = effective
887   uid=uuuu gid=CALLER_GID pid=p1237
888 configuration file is TESTSUITE/test-config
889 admin user
890 dropping to exim gid; retaining priv uid
891 originator: uid=CALLER_UID gid=CALLER_GID login=CALLER name=CALLER_NAME
892 sender address = CALLER@myhost.test.ex
893 Address testing: uid=uuuu gid=EXIM_GID euid=uuuu egid=EXIM_GID
894 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
895 Testing srv@test.again.dns
896 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
897 Considering srv@test.again.dns
898 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
899 routing srv@test.again.dns
900 --------> srv router <--------
901 local_part=srv domain=test.again.dns
902 checking local_parts
903 srv in local_parts?
904  list element: ^srv
905  compiled caseless RE '^srv' not found in local cache
906  compiled RE '^srv' saved in local cache
907  srv in local_parts? yes (matched "^srv")
908 calling srv router
909 srv router called for srv@test.again.dns
910   domain = test.again.dns
911 main lookup for domain
912  check dnssec require list
913   test.again.dns in dnssec_require_domains? no (option unset)
914  check dnssec request list
915   test.again.dns in dnssec_request_domains?
916    list element: *
917    test.again.dns in dnssec_request_domains? yes (matched "*")
918  DNS lookup of _smtp._tcp.test.again.dns (SRV) using fakens
919  DNS lookup of _smtp._tcp.test.again.dns (SRV) gave TRY_AGAIN
920  _smtp._tcp.test.again.dns in dns_again_means_nonexist? no (option unset)
921  returning DNS_AGAIN
922   writing neg-cache entry for _smtp._tcp.test.again.dns-SRV-xxxx, ttl -1
923  test.again.dns in srv_fail_domains?
924   list element: test.fail.dns
925  test.again.dns in srv_fail_domains? no (end of list)
926 srv router: defer for srv@test.again.dns
927   message: host lookup did not complete
928 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
929 Testing srv@test.fail.dns
930 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
931 Considering srv@test.fail.dns
932 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
933 routing srv@test.fail.dns
934 --------> srv router <--------
935 local_part=srv domain=test.fail.dns
936 checking local_parts
937 srv in local_parts?
938  list element: ^srv
939  compiled caseless RE '^srv' found in local cache
940  srv in local_parts? yes (matched "^srv")
941 calling srv router
942 srv router called for srv@test.fail.dns
943   domain = test.fail.dns
944 main lookup for domain
945  check dnssec require list
946   test.fail.dns in dnssec_require_domains? no (option unset)
947  check dnssec request list
948   test.fail.dns in dnssec_request_domains?
949    list element: *
950    test.fail.dns in dnssec_request_domains? yes (matched "*")
951  DNS lookup of _smtp._tcp.test.fail.dns (SRV) using fakens
952  DNS lookup of _smtp._tcp.test.fail.dns (SRV) gave NO_RECOVERY
953  returning DNS_FAIL
954   writing neg-cache entry for _smtp._tcp.test.fail.dns-SRV-xxxx, ttl -1
955  test.fail.dns in srv_fail_domains?
956   list element: test.fail.dns
957   test.fail.dns in srv_fail_domains? yes (matched "test.fail.dns")
958  DNS_FAIL treated as DNS_NODATA (domain in srv_fail_domains)
959  DNS lookup of test.fail.dns (MX) using fakens
960  DNS lookup of test.fail.dns (MX) gave NO_RECOVERY
961  returning DNS_FAIL
962   writing neg-cache entry for test.fail.dns-MX-xxxx, ttl -1
963  test.fail.dns in mx_fail_domains?
964   list element: test.fail.dns
965   test.fail.dns in mx_fail_domains? yes (matched "test.fail.dns")
966  DNS_FAIL treated as DNS_NODATA (domain in mx_fail_domains)
967  DNS lookup of test.fail.dns (A) using fakens
968  DNS lookup of test.fail.dns (A) gave NO_RECOVERY
969  returning DNS_FAIL
970   writing neg-cache entry for test.fail.dns-A-xxxx, ttl -1
971 srv router: defer for srv@test.fail.dns
972   message: host lookup did not complete
973 search_tidyup called
974 >>>>>>>>>>>>>>>> Exim pid=p1237 (fresh-exec) terminating with rc=1 >>>>>>>>>>>>>>>>
975 Exim version x.yz ....
976 Hints DB:
977 changed uid/gid: forcing real = effective
978   uid=uuuu gid=CALLER_GID pid=p1238
979 configuration file is TESTSUITE/test-config
980 admin user
981 dropping to exim gid; retaining priv uid
982 originator: uid=CALLER_UID gid=CALLER_GID login=CALLER name=CALLER_NAME
983 sender address = CALLER@myhost.test.ex
984 Address testing: uid=uuuu gid=EXIM_GID euid=uuuu egid=EXIM_GID
985 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
986 Testing userx@nonexist.example.com
987 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
988 Considering userx@nonexist.example.com
989 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
990 routing userx@nonexist.example.com
991 --------> srv router <--------
992 local_part=userx domain=nonexist.example.com
993 checking local_parts
994 userx in local_parts?
995  list element: ^srv
996  compiled caseless RE '^srv' not found in local cache
997  compiled RE '^srv' saved in local cache
998 userx in local_parts? no (end of list)
999 srv router skipped: local_parts mismatch
1000 --------> useryz router <--------
1001 local_part=userx domain=nonexist.example.com
1002 checking local_parts
1003 userx in local_parts?
1004  list element: usery
1005  list element: userz
1006 userx in local_parts? no (end of list)
1007 useryz router skipped: local_parts mismatch
1008 --------> lookuphost router <--------
1009 local_part=userx domain=nonexist.example.com
1010 checking local_parts
1011 userx in local_parts?
1012  list element: !userd
1013 userx in local_parts? yes (end of list)
1014 calling lookuphost router
1015 lookuphost router called for userx@nonexist.example.com
1016   domain = nonexist.example.com
1017 main lookup for domain
1018  check dnssec require list
1019   nonexist.example.com in dnssec_require_domains? no (option unset)
1020  check dnssec request list
1021   nonexist.example.com in dnssec_request_domains?
1022    list element: *
1023    nonexist.example.com in dnssec_request_domains? yes (matched "*")
1024  DNS lookup of nonexist.example.com (MX) using fakens
1025  DNS lookup of nonexist.example.com (MX) gave HOST_NOT_FOUND
1026  returning DNS_NOMATCH
1027  faking res_search(MX) response length as 65535
1028   writing neg-cache entry for nonexist.example.com-MX-xxxx, ttl 2
1029 lookuphost router declined for userx@nonexist.example.com
1030 "more" is false: skipping remaining routers
1031 no more routers
1032 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
1033 Testing userd@nonexist.example.com
1034 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
1035 Considering userd@nonexist.example.com
1036 >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>
1037 routing userd@nonexist.example.com
1038 --------> srv router <--------
1039 local_part=userd domain=nonexist.example.com
1040 checking local_parts
1041 userd in local_parts?
1042  list element: ^srv
1043  compiled caseless RE '^srv' found in local cache
1044 userd in local_parts? no (end of list)
1045 srv router skipped: local_parts mismatch
1046 --------> useryz router <--------
1047 local_part=userd domain=nonexist.example.com
1048 checking local_parts
1049 userd in local_parts?
1050  list element: usery
1051  list element: userz
1052 userd in local_parts? no (end of list)
1053 useryz router skipped: local_parts mismatch
1054 --------> lookuphost router <--------
1055 local_part=userd domain=nonexist.example.com
1056 checking local_parts
1057 userd in local_parts?
1058  list element: !userd
1059  userd in local_parts? no (matched "!userd")
1060 lookuphost router skipped: local_parts mismatch
1061 --------> delay router <--------
1062 local_part=userd domain=nonexist.example.com
1063 checking "condition" "${acl {delay}}"...
1064   using ACL "delay"
1065   processing "accept" (TESTSUITE/test-config 18)
1066   check delay = 3s
1067   delay modifier requests 3-second delay
1068     message: y
1069   accept: condition test succeeded in ACL "delay"
1070   end of ACL "delay": ACCEPT
1071 calling delay router
1072 delay router called for userd@nonexist.example.com
1073   domain = nonexist.example.com
1074 main lookup for domain
1075  check dnssec require list
1076   nonexist.example.com in dnssec_require_domains? no (option unset)
1077  check dnssec request list
1078   nonexist.example.com in dnssec_request_domains?
1079    list element: *
1080    nonexist.example.com in dnssec_request_domains? yes (matched "*")
1081  DNS lookup of nonexist.example.com (MX): cached value DNS_NOMATCH past valid time
1082  DNS lookup of nonexist.example.com (MX) using fakens
1083  DNS lookup of nonexist.example.com (MX) gave HOST_NOT_FOUND
1084  returning DNS_NOMATCH
1085  faking res_search(MX) response length as 65535
1086   update neg-cache entry for nonexist.example.com-MX-xxxx, ttl 2
1087 delay router declined for userd@nonexist.example.com
1088 "more" is false: skipping remaining routers
1089 no more routers
1090 search_tidyup called
1091 >>>>>>>>>>>>>>>> Exim pid=p1238 (fresh-exec) terminating with rc=2 >>>>>>>>>>>>>>>>