test/stderr/0476

   1 Exim version x.yz ....
   2 configuration file is TESTSUITE/test-config
   3 admin user
   4 dropping to exim gid; retaining priv uid
   5 set_process_info: pppp running the queue (single queue run)
   6 LOG: queue_run MAIN
   7   Start queue run: pid=p1234
   8 set_process_info: pppp running queue: 10HmaX-000000005vi-0000
   9 set_process_info: pppp delivering 10HmaX-000000005vi-0000 (queue run pid p1234)
  10 >>>>>>>>>>>>>>>> Remote deliveries >>>>>>>>>>>>>>>>
  11 --------> userx@test.ex <--------
  12 set_process_info: pppp delivering 10HmaX-000000005vi-0000 using t1
  13 t1 transport entered
  14   userx@test.ex
  15 hostlist:
  16   '127.0.0.1' IP 127.0.0.1 port -1
  17 checking retry status of 127.0.0.1
  18 127.0.0.1 [127.0.0.1]:1111 retry-status = usable
  19 delivering 10HmaX-000000005vi-0000 to 127.0.0.1 [127.0.0.1] (userx@test.ex)
  20 set_process_info: pppp delivering 10HmaX-000000005vi-0000 to 127.0.0.1 [127.0.0.1]:PORT_S (userx@test.ex)
  21 Connecting to 127.0.0.1 [127.0.0.1]:PORT_S ...
  22  connected
  23   SMTP<< 220 Server ready
  24   SMTP>> EHLO the.local.host.name
  25 cmd buf flush ddd bytes
  26   SMTP<< 250-server id
  27          250-PIPELINING
  28          250 OK
  29 using PIPELINING
  30 not using DSN
  31   SMTP|> MAIL FROM:<CALLER@the.local.host.name>
  32   SMTP|> RCPT TO:<userx@test.ex>
  33   SMTP>> DATA
  34 cmd buf flush ddd bytes
  35 sync_responses expect mail
  36   SMTP<< 250 OK
  37 sync_responses expect rcpt for userx@test.ex
  38   SMTP<< 550 NO
  39 sync_responses expect data
  40   SMTP(closed)<<
  41 Remote host closed connection in response to pipelined DATA
  42 error for DATA ignored: pipelining is in use and there were no good recipients
  43 ok=1 send_quit=1 send_rset=1 continue_more=0 yield=0 first_address is NULL
  44 transport_check_waiting entered
  45   sequence=1 local_max=500 global_max=-1
  46 transport_check_waiting: TRUE
  47   SMTP>> RSET
  48 cmd buf flush ddd bytes
  49   SMTP(closed)<<
  50 H=127.0.0.1 [127.0.0.1] Remote host closed connection in response to RSET
  51   SMTP(close)>>
  52 cmdlog: '220:EHLO:250-:MAIL|:RCPT|:DATA:250:550:RSET'
  53 set_process_info: pppp delivering 10HmaX-000000005vi-0000: just tried 127.0.0.1 [127.0.0.1]:PORT_S for userx@test.ex: result OK
  54 Leaving t1 transport
  55 set_process_info: pppp delivering 10HmaX-000000005vi-0000 (just run t1 for userx@test.ex in subprocess)
  56 set_process_info: pppp running queue: waiting for 10HmaX-000000005vi-0000 (pppp)
  57 set_process_info: pppp delivering 10HmaX-000000005vi-0000: waiting for a remote delivery subprocess to finish
  58 set_process_info: pppp delivering 10HmaX-000000005vi-0000
  59 LOG: MAIN
  60   ** userx@test.ex R=r1 T=t1 H=127.0.0.1 [127.0.0.1]: SMTP error from remote mail server after RCPT TO:<userx@test.ex>: 550 NO
  61 set_process_info: pppp tidying up after delivering 10HmaX-000000005vi-0000
  62 Exim version x.yz ....
  63 configuration file is TESTSUITE/test-config
  64 trusted user
  65 admin user
  66 set_process_info: pppp accepting a local non-SMTP message from <>
  67 cannot use sendfile for body: spoolfile not wireformat
  68 writing data block fd=dddd size=sss timeout=0
  69 LOG: MAIN
  70   <= <> R=10HmaX-000000005vi-0000 U=EXIMUSER P=local S=sss
  71 Exim version x.yz ....
  72 configuration file is TESTSUITE/test-config
  73 trusted user
  74 admin user
  75 dropping to exim gid; retaining priv uid
  76 set_process_info: pppp delivering specified messages
  77 set_process_info: pppp delivering 10HmaZ-000000005vi-0000
  78 >>>>>>>>>>>>>>>> Remote deliveries >>>>>>>>>>>>>>>>
  79 --------> CALLER@the.local.host.name <--------
  80 set_process_info: pppp delivering 10HmaZ-000000005vi-0000 using t1
  81 t1 transport entered
  82   CALLER@the.local.host.name
  83 hostlist:
  84   '127.0.0.1' IP 127.0.0.1 port -1
  85 checking retry status of 127.0.0.1
  86 127.0.0.1 [127.0.0.1]:1111 retry-status = usable
  87 delivering 10HmaZ-000000005vi-0000 to 127.0.0.1 [127.0.0.1] (CALLER@the.local.host.name)
  88 set_process_info: pppp delivering 10HmaZ-000000005vi-0000 to 127.0.0.1 [127.0.0.1]:PORT_S (CALLER@the.local.host.name)
  89 Connecting to 127.0.0.1 [127.0.0.1]:PORT_S ...
  90   failed: Connection refused
  91 LOG: MAIN
  92   H=127.0.0.1 [127.0.0.1] Connection refused
  93 set_process_info: pppp delivering 10HmaZ-000000005vi-0000: just tried 127.0.0.1 [127.0.0.1]:PORT_S for CALLER@the.local.host.name: result DEFER
  94 added retry item for T:[127.0.0.1]:127.0.0.1:PORT_S: errno=dd more_errno=dd,A flags=2
  95 all IP addresses skipped or deferred at least one address
  96 updating wait-t1 database
  97 added 10HmaZ-000000005vi-0000 to queue for 127.0.0.1
  98 Leaving t1 transport
  99 set_process_info: pppp delivering 10HmaZ-000000005vi-0000 (just run t1 for CALLER@the.local.host.name in subprocess)
 100 set_process_info: pppp delivering 10HmaZ-000000005vi-0000: waiting for a remote delivery subprocess to finish
 101 set_process_info: pppp delivering 10HmaZ-000000005vi-0000
 102 LOG: MAIN
 103   == CALLER@the.local.host.name R=r1 T=t1 defer (dd): Connection refused
 104 set_process_info: pppp tidying up after delivering 10HmaZ-000000005vi-0000
 105 >>>>>>>>>>>>>>>> Exim pid=p1236 (local-accept-delivery) terminating with rc=0 >>>>>>>>>>>>>>>>
 106 >>>>>>>>>>>>>>>> Exim pid=p1235 (bounce-message) terminating with rc=0 >>>>>>>>>>>>>>>>
 107 LOG: MAIN
 108   Completed
 109 >>>>>>>>>>>>>>>> Exim pid=p1237 (qrun-delivery) terminating with rc=0 >>>>>>>>>>>>>>>>
 110 set_process_info: pppp running queue: waiting for children of pppp
 111 set_process_info: pppp running queue
 112 set_process_info: pppp running queue: 10HmaY-000000005vi-0000
 113 set_process_info: pppp delivering 10HmaY-000000005vi-0000 (queue run pid p1234)
 114 >>>>>>>>>>>>>>>> Remote deliveries >>>>>>>>>>>>>>>>
 115 --------> usery@test.ex <--------
 116 set_process_info: pppp delivering 10HmaY-000000005vi-0000 using t1
 117 t1 transport entered
 118   usery@test.ex
 119 hostlist:
 120   '127.0.0.1' IP 127.0.0.1 port -1
 121 checking retry status of 127.0.0.1
 122 no message retry record
 123 127.0.0.1 [127.0.0.1]:1111 retry-status = unusable
 124 all IP addresses skipped or deferred at least one address
 125 updating wait-t1 database
 126 added 10HmaY-000000005vi-0000 to queue for 127.0.0.1
 127 Leaving t1 transport
 128 set_process_info: pppp delivering 10HmaY-000000005vi-0000 (just run t1 for usery@test.ex in subprocess)
 129 set_process_info: pppp running queue: waiting for 10HmaY-000000005vi-0000 (pppp)
 130 set_process_info: pppp delivering 10HmaY-000000005vi-0000: waiting for a remote delivery subprocess to finish
 131 set_process_info: pppp delivering 10HmaY-000000005vi-0000
 132 LOG: retry_defer MAIN
 133   == usery@test.ex R=r1 T=t1 defer (-54): retry time not reached for any host for 'test.ex'
 134 set_process_info: pppp tidying up after delivering 10HmaY-000000005vi-0000
 135 >>>>>>>>>>>>>>>> Exim pid=p1238 (qrun-delivery) terminating with rc=0 >>>>>>>>>>>>>>>>
 136 set_process_info: pppp running queue: waiting for children of pppp
 137 set_process_info: pppp running queue
 138 LOG: queue_run MAIN
 139   End queue run: pid=p1234
 140 >>>>>>>>>>>>>>>> Exim pid=p1234 (fresh-exec) terminating with rc=0 >>>>>>>>>>>>>>>>