I've been noticing that messages haven't been getting retried based on what
I've wanted Exim to do via the retry rules I've set, and I found a prime
example today and couldn't figure out why there was such a huge delay
between when the server was retried, so now I'm hoping that someone on the
list can help me figure this out.
Here's the global settings (pertaining to retries), the router, the
transport, and the retry rules (all of them just in case):
#---------
retry_data_expire = 7d
retry_interval_max = 1d
delay_warning = 4h : 12h : 1d : 2d
manual_address_large:
driver = manualroute
domains = +treat_as_local
condition = ${if > {$message_size}{1M} {yes}{no}}
ignore_target_hosts = 0.0.0.0 : 127.0.0.0/8
cannot_route_message = The domain $domain is not a known local
domain
route_list = * 66.165.106.102:66.165.106.103 randomize
transport = manual_delivery
retry_use_local_part = yes
more = no
manual_delivery:
driver = smtp
multi_domain = no
size_addition = -1
retry_use_local_part = yes
66.165.106.102 * F,3h,5m; F,12h,15m; F,1d,1h; F,2d,3h
66.165.106.103 * F,3h,5m; F,12h,15m; F,1d,1h; F,2d,3h
66.165.106.126 * F,3h,5m; F,12h,15m; F,1d,1h; F,2d,3h
* quota F,7d,3h
* * F,2h,15m; G,12h,1h,1.5; F,4d,6h
#---------
Here's what happened to a message when those (66.165.106.102 &
66.165.106.103) systems failed to handle the message (no idea why but that's
not my concern right now) until the 3rd or 4th attempt:
#---------
Jul 21 13:11:12 scanmail3 exim[21147]: 1DveXG-0005V5-V4 <= XXXX
H=smtp9.clb.oleane.net [213.56.31.31] I=[10.1.0.113]:25 P=esmtp S=4056913
id=026801c58e16$b7b9f7d0$8f02a8c0@cds from <XXXX> for XXXX
Jul 21 13:16:34 scanmail3 exim[21941]: 1DveXG-0005V5-V4 66.165.106.102
[66.165.106.102]: Broken pipe
Jul 21 13:25:43 scanmail3 exim[21941]: 1DveXG-0005V5-V4 66.165.106.103
[66.165.106.103]: Broken pipe
Jul 21 13:25:43 scanmail3 exim[21940]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (32): Broken pipe:
66.165.106.103 [66.165.106.103]
Jul 21 13:28:22 scanmail3 exim[27106]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 13:30:39 scanmail3 exim[27844]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 13:31:43 scanmail3 exim[28524]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 13:56:16 scanmail3 exim[2576]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 13:57:35 scanmail3 exim[3149]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 13:58:39 scanmail3 exim[3509]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 14:05:20 scanmail3 exim[4203]: 1DveXG-0005V5-V4 66.165.106.102
[66.165.106.102]: Connection reset by peer
Jul 21 14:05:20 scanmail3 exim[4202]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (104): Connection reset by
peer: 66.165.106.102 [66.165.106.102]
Jul 21 14:05:20 scanmail3 exim[5730]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 14:05:37 scanmail3 exim[6039]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 14:37:35 scanmail3 exim[15766]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 14:38:44 scanmail3 exim[16206]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 14:39:24 scanmail3 exim[16515]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 14:40:41 scanmail3 exim[17104]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 14:41:46 scanmail3 exim[17620]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 14:46:05 scanmail3 exim[18957]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 14:47:23 scanmail3 exim[19391]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 14:48:06 scanmail3 exim[19801]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 14:50:37 scanmail3 exim[20500]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 14:55:38 scanmail3 exim[21924]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 15:16:14 scanmail3 exim[26859]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 15:17:50 scanmail3 exim[27392]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 15:41:16 scanmail3 exim[604]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 15:45:14 scanmail3 exim[1607]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 15:45:39 scanmail3 exim[1946]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 15:49:56 scanmail3 exim[3133]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 15:50:37 scanmail3 exim[3670]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 16:02:14 scanmail3 exim[6569]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 16:02:18 scanmail3 exim[6673]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 16:05:38 scanmail3 exim[7935]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 16:10:52 scanmail3 exim[9338]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 16:28:00 scanmail3 exim[13894]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 16:29:06 scanmail3 exim[14359]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 16:30:31 scanmail3 exim[14902]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 16:30:37 scanmail3 exim[15144]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 16:43:40 scanmail3 exim[18313]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 16:43:53 scanmail3 exim[18525]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 16:45:21 scanmail3 exim[18985]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 16:45:37 scanmail3 exim[19175]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 16:46:08 scanmail3 exim[19572]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 16:57:16 scanmail3 exim[22256]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 17:10:23 scanmail3 exim[25246]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 17:10:46 scanmail3 exim[25636]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 17:12:22 scanmail3 exim[26067]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 17:23:06 scanmail3 exim[28536]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 17:27:28 scanmail3 exim[29901]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 17:49:21 scanmail3 exim[1780]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 17:50:01 scanmail3 exim[2074]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 17:53:27 scanmail3 exim[2975]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 17:53:56 scanmail3 exim[3298]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 17:58:48 scanmail3 exim[4396]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 17:59:47 scanmail3 exim[4730]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 18:00:37 scanmail3 exim[5073]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 18:08:15 scanmail3 exim[6683]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 18:24:09 scanmail3 exim[9949]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 18:31:24 scanmail3 exim[11433]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 18:31:37 scanmail3 exim[11664]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 18:43:17 scanmail3 exim[14224]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 18:46:30 scanmail3 exim[15134]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 19:10:36 scanmail3 exim[19645]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 19:10:38 scanmail3 exim[19774]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 19:10:44 scanmail3 exim[20013]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 19:12:39 scanmail3 exim[20596]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 19:12:51 scanmail3 exim[20700]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 19:19:55 scanmail3 exim[21948]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 19:27:48 scanmail3 exim[23754]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (-53): retry time not reached
for any host
Jul 21 19:40:40 scanmail3 exim[24120]: 1DveXG-0005V5-V4 66.165.106.102
[66.165.106.102]: Broken pipe
Jul 21 19:40:40 scanmail3 exim[24119]: 1DveXG-0005V5-V4 == XXXX
R=manual_address_large T=manual_delivery defer (32): Broken pipe:
66.165.106.102 [66.165.106.102]
Jul 21 19:40:40 scanmail3 exim[26011]: 1Dvkee-0006lX-5B <= <>
R=1DveXG-0005V5-V4 U=mail P=local S=1223 from <> for XXXX
Jul 21 19:56:35 scanmail3 exim[26035]: 1DveXG-0005V5-V4 => XXXX F=<XXXX>
R=manual_address_large T=manual_delivery S=4109702 H=66.165.106.103
[66.165.106.103]* QT=6h47m57s DT=15m47s
Jul 21 19:56:35 scanmail3 exim[26035]: 1DveXG-0005V5-V4 Completed
QT=6h47m57s
#---------
I've got a queue runner which runs every 5 minutes (-q5m) as well as another
exim process which handles the incoming connections. The initial delivery
failed due to broken pipe, then 9m later (not sure why ~9m, I'd assume
closer to 5m) it tries the other host which fails too. Then it doesn't
retry either of them until ~40m later when it should have tried again every
~5m according to my retry rules. It fails again on that try, then doesn't
try again for another ~5.5h which makes no sense to me (it should have tried
every ~5m for 3hrs, then every 15m up to 12h on queue). It failed again
then too (heh) and then it generated a bounceback since it had passed 4hrs,
then it tried another delivery at 7:56 (16m since the last try) and finally
succeeded.
Is it the quota retry entry that might be causing this problem? If so I can
remove that since I don't even use it, but I can't figure out why the
retries weren't even *close* to what I think I've got them set to (I say
think in case they're not correctly set).
Any ideas?
Eli.
