Skip to content

Instantly share code, notes, and snippets.

@bigeasy
Created August 8, 2011 11:44
Show Gist options
  • Star 0 You must be signed in to star a gist
  • Fork 0 You must be signed in to fork a gist
  • Save bigeasy/1131622 to your computer and use it in GitHub Desktop.
Save bigeasy/1131622 to your computer and use it in GitHub Desktop.
Unbound Verbose Logging Output
Aug 8 11:19:37 celje unbound: [6707:0] debug: caught signal SIGTERM
Aug 8 11:19:37 celje unbound: [6707:0] info: service stopped (unbound 1.4.8).
Aug 8 11:19:37 celje unbound: [6707:0] debug: stop threads
Aug 8 11:19:37 celje unbound: [6707:0] debug: cleanup.
Aug 8 11:19:37 celje unbound: [6707:0] info: server stats for thread 0: 0 queries, 0 answers from cache, 0 recursions, 0 prefetch
Aug 8 11:19:37 celje unbound: [6707:0] info: server stats for thread 0: requestlist max 0 avg 0 exceeded 0
Aug 8 11:19:37 celje unbound: [6707:0] info: mesh has 0 recursion states (0 with reply, 0 detached), 0 waiting replies, 0 recursion replies sent, 0 replies dropped, 0 states jostled out
Aug 8 11:19:37 celje unbound: [6707:0] debug: cache memory msg=33040 rrset=33040 infra=1316 val=41428
Aug 8 11:19:37 celje unbound: [6707:0] debug: Exit cleanup.
Aug 8 11:19:37 celje unbound: [6707:0] debug: switching log to stderr
Aug 8 11:20:10 celje unbound: [6761:0] debug: setup SSL certificates
Aug 8 11:20:10 celje unbound: [6762:0] debug: chdir to /etc/unbound
Aug 8 11:20:10 celje unbound: [6762:0] debug: module config: "validator iterator"
Aug 8 11:20:10 celje unbound: [6762:0] notice: init module 0: validator
Aug 8 11:20:10 celje unbound: [6762:0] debug: reading in bind-compat-mode: '/etc/unbound/root.key'
Aug 8 11:20:10 celje unbound: [6762:0] info: adding trusted key <dlv.isc.org. DNSKEY IN>
Aug 8 11:20:10 celje unbound: [6762:0] debug: validator nsec3cfg keysz 1024 mxiter 150
Aug 8 11:20:10 celje unbound: [6762:0] debug: validator nsec3cfg keysz 2048 mxiter 500
Aug 8 11:20:10 celje unbound: [6762:0] debug: validator nsec3cfg keysz 4096 mxiter 2500
Aug 8 11:20:10 celje unbound: [6762:0] notice: init module 1: iterator
Aug 8 11:20:10 celje unbound: [6762:0] debug: target fetch policy for level 0 is 3
Aug 8 11:20:10 celje unbound: [6762:0] debug: target fetch policy for level 1 is 2
Aug 8 11:20:10 celje unbound: [6762:0] debug: target fetch policy for level 2 is 1
Aug 8 11:20:10 celje unbound: [6762:0] debug: target fetch policy for level 3 is 0
Aug 8 11:20:10 celje unbound: [6762:0] debug: target fetch policy for level 4 is 0
Aug 8 11:20:10 celje unbound: [6762:0] debug: Reading root hints from /etc/unbound/root.hints
Aug 8 11:20:10 celje unbound: [6762:0] info: DelegationPoint<.>: 13 names (4 missing), 22 addrs (0 result, 22 avail) parentNS
Aug 8 11:20:10 celje unbound: [6762:0] info: M.ROOT-SERVERS.NET. * A AAAA
Aug 8 11:20:10 celje unbound: [6762:0] info: L.ROOT-SERVERS.NET. * A AAAA
Aug 8 11:20:10 celje unbound: [6762:0] info: K.ROOT-SERVERS.NET. * A AAAA
Aug 8 11:20:10 celje unbound: [6762:0] info: J.ROOT-SERVERS.NET. * A AAAA
Aug 8 11:20:10 celje unbound: [6762:0] info: I.ROOT-SERVERS.NET. * A AAAA
Aug 8 11:20:10 celje unbound: [6762:0] info: H.ROOT-SERVERS.NET. * A AAAA
Aug 8 11:20:10 celje unbound: [6762:0] info: G.ROOT-SERVERS.NET. A
Aug 8 11:20:10 celje unbound: [6762:0] info: F.ROOT-SERVERS.NET. * A AAAA
Aug 8 11:20:10 celje unbound: [6762:0] info: E.ROOT-SERVERS.NET. A
Aug 8 11:20:10 celje unbound: [6762:0] info: D.ROOT-SERVERS.NET. * A AAAA
Aug 8 11:20:10 celje unbound: [6762:0] info: C.ROOT-SERVERS.NET. A
Aug 8 11:20:10 celje unbound: [6762:0] info: B.ROOT-SERVERS.NET. A
Aug 8 11:20:10 celje unbound: [6762:0] info: A.ROOT-SERVERS.NET. * A AAAA
Aug 8 11:20:10 celje unbound: [6762:0] debug: ip6 2001:dc3::35 port 53 (len 28)
Aug 8 11:20:10 celje unbound: [6762:0] debug: ip4 202.12.27.33 port 53 (len 16)
Aug 8 11:20:10 celje unbound: [6762:0] debug: ip6 2001:500:3::42 port 53 (len 28)
Aug 8 11:20:10 celje unbound: [6762:0] debug: ip4 199.7.83.42 port 53 (len 16)
Aug 8 11:20:10 celje unbound: [6762:0] debug: ip6 2001:7fd::1 port 53 (len 28)
Aug 8 11:20:10 celje unbound: [6762:0] debug: ip4 193.0.14.129 port 53 (len 16)
Aug 8 11:20:10 celje unbound: [6762:0] debug: ip6 2001:503:c27::2:30 port 53 (len 28)
Aug 8 11:20:10 celje unbound: [6762:0] debug: ip4 192.58.128.30 port 53 (len 16)
Aug 8 11:20:10 celje unbound: [6762:0] debug: ip6 2001:7fe::53 port 53 (len 28)
Aug 8 11:20:10 celje unbound: [6762:0] debug: ip4 192.36.148.17 port 53 (len 16)
Aug 8 11:20:10 celje unbound: [6762:0] debug: ip6 2001:500:1::803f:235 port 53 (len 28)
Aug 8 11:20:10 celje unbound: [6762:0] debug: ip4 128.63.2.53 port 53 (len 16)
Aug 8 11:20:10 celje unbound: [6762:0] debug: ip4 192.112.36.4 port 53 (len 16)
Aug 8 11:20:10 celje unbound: [6762:0] debug: ip6 2001:500:2f::f port 53 (len 28)
Aug 8 11:20:10 celje unbound: [6762:0] debug: ip4 192.5.5.241 port 53 (len 16)
Aug 8 11:20:10 celje unbound: [6762:0] debug: ip4 192.203.230.10 port 53 (len 16)
Aug 8 11:20:10 celje unbound: [6762:0] debug: ip6 2001:500:2d::d port 53 (len 28)
Aug 8 11:20:10 celje unbound: [6762:0] debug: ip4 128.8.10.90 port 53 (len 16)
Aug 8 11:20:10 celje unbound: [6762:0] debug: ip4 192.33.4.12 port 53 (len 16)
Aug 8 11:20:10 celje unbound: [6762:0] debug: ip4 192.228.79.201 port 53 (len 16)
Aug 8 11:20:10 celje unbound: [6762:0] debug: ip6 2001:503:ba3e::2:30 port 53 (len 28)
Aug 8 11:20:10 celje unbound: [6762:0] debug: ip4 198.41.0.4 port 53 (len 16)
Aug 8 11:20:10 celje unbound: [6762:0] debug: donotq: 127.0.0.0/8
Aug 8 11:20:10 celje unbound: [6762:0] debug: total of 59641 outgoing ports available
Aug 8 11:20:10 celje unbound: [6762:0] debug: start threads
Aug 8 11:20:10 celje unbound: [6762:0] debug: libevent 2.0.10-stable uses epoll method.
Aug 8 11:20:10 celje unbound: [6762:0] debug: cache memory msg=33040 rrset=33040 infra=1316 val=41428
Aug 8 11:20:10 celje unbound: [6762:0] info: start of service (unbound 1.4.8).
Aug 8 11:20:25 celje unbound: [6762:0] debug: udp request from ip4 127.0.0.1 port 46516 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: mesh_run: start
Aug 8 11:20:25 celje unbound: [6762:0] debug: validator[module 0] operate: extstate:module_state_initial event:module_event_new
Aug 8 11:20:25 celje unbound: [6762:0] info: validator operate: query <. NS IN>
Aug 8 11:20:25 celje unbound: [6762:0] debug: validator: pass to next module
Aug 8 11:20:25 celje unbound: [6762:0] debug: mesh_run: validator module exit state is module_wait_module
Aug 8 11:20:25 celje unbound: [6762:0] debug: iterator[module 1] operate: extstate:module_state_initial event:module_event_pass
Aug 8 11:20:25 celje unbound: [6762:0] debug: process_request: new external request event
Aug 8 11:20:25 celje unbound: [6762:0] debug: iter_handle processing q with state INIT REQUEST STATE
Aug 8 11:20:25 celje unbound: [6762:0] info: resolving <. NS IN>
Aug 8 11:20:25 celje unbound: [6762:0] debug: request has dependency depth of 0
Aug 8 11:20:25 celje unbound: [6762:0] info: priming . IN NS
Aug 8 11:20:25 celje unbound: [6762:0] debug: mesh_run: iterator module exit state is module_wait_subquery
Aug 8 11:20:25 celje unbound: [6762:0] debug: iterator[module 1] operate: extstate:module_state_initial event:module_event_pass
Aug 8 11:20:25 celje unbound: [6762:0] info: iterator operate: query <. NS IN>
Aug 8 11:20:25 celje unbound: [6762:0] debug: iter_handle processing q with state QUERY TARGETS STATE
Aug 8 11:20:25 celje unbound: [6762:0] info: processQueryTargets: <. NS IN>
Aug 8 11:20:25 celje unbound: [6762:0] debug: processQueryTargets: targetqueries 0, currentqueries 0
Aug 8 11:20:25 celje unbound: [6762:0] info: DelegationPoint<.>: 13 names (0 missing), 22 addrs (0 result, 22 avail) parentNS
Aug 8 11:20:25 celje unbound: [6762:0] info: A.ROOT-SERVERS.NET. * A AAAA
Aug 8 11:20:25 celje unbound: [6762:0] info: B.ROOT-SERVERS.NET. * A
Aug 8 11:20:25 celje unbound: [6762:0] info: C.ROOT-SERVERS.NET. * A
Aug 8 11:20:25 celje unbound: [6762:0] info: D.ROOT-SERVERS.NET. * A AAAA
Aug 8 11:20:25 celje unbound: [6762:0] info: E.ROOT-SERVERS.NET. * A
Aug 8 11:20:25 celje unbound: [6762:0] info: F.ROOT-SERVERS.NET. * A AAAA
Aug 8 11:20:25 celje unbound: [6762:0] info: G.ROOT-SERVERS.NET. * A
Aug 8 11:20:25 celje unbound: [6762:0] info: H.ROOT-SERVERS.NET. * A AAAA
Aug 8 11:20:25 celje unbound: [6762:0] info: I.ROOT-SERVERS.NET. * A AAAA
Aug 8 11:20:25 celje unbound: [6762:0] info: J.ROOT-SERVERS.NET. * A AAAA
Aug 8 11:20:25 celje unbound: [6762:0] info: K.ROOT-SERVERS.NET. * A AAAA
Aug 8 11:20:25 celje unbound: [6762:0] info: L.ROOT-SERVERS.NET. * A AAAA
Aug 8 11:20:25 celje unbound: [6762:0] info: M.ROOT-SERVERS.NET. * A AAAA
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 198.41.0.4 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip6 2001:503:ba3e::2:30 port 53 (len 28)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 192.228.79.201 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 192.33.4.12 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 128.8.10.90 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip6 2001:500:2d::d port 53 (len 28)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 192.203.230.10 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 192.5.5.241 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip6 2001:500:2f::f port 53 (len 28)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 192.112.36.4 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 128.63.2.53 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip6 2001:500:1::803f:235 port 53 (len 28)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 192.36.148.17 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip6 2001:7fe::53 port 53 (len 28)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 192.58.128.30 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip6 2001:503:c27::2:30 port 53 (len 28)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 193.0.14.129 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip6 2001:7fd::1 port 53 (len 28)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 199.7.83.42 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip6 2001:500:3::42 port 53 (len 28)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 202.12.27.33 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip6 2001:dc3::35 port 53 (len 28)
Aug 8 11:20:25 celje unbound: [6762:0] debug: attempt to get extra 2 targets
Aug 8 11:20:25 celje unbound: [6762:0] debug: selrtt 376
Aug 8 11:20:25 celje unbound: [6762:0] info: sending query: <. NS IN>
Aug 8 11:20:25 celje unbound: [6762:0] debug: sending to target: <.> 192.36.148.17#53
Aug 8 11:20:25 celje unbound: [6762:0] debug: dnssec status: not expected
Aug 8 11:20:25 celje unbound: [6762:0] debug: EDNS lookup known=0 vs=0
Aug 8 11:20:25 celje unbound: [6762:0] debug: serviced query UDP timeout=376 msec
Aug 8 11:20:25 celje unbound: [6762:0] debug: inserted new pending reply id=edef
Aug 8 11:20:25 celje unbound: [6762:0] debug: opened UDP if=0 port=12829
Aug 8 11:20:25 celje unbound: [6762:0] debug: comm point start listening 13
Aug 8 11:20:25 celje unbound: [6762:0] debug: mesh_run: iterator module exit state is module_wait_reply
Aug 8 11:20:25 celje unbound: [6762:0] info: mesh_run: end 2 recursion states (1 with reply, 0 detached), 1 waiting replies, 0 recursion replies sent, 0 replies dropped, 0 states jostled out
Aug 8 11:20:25 celje unbound: [6762:0] info: 0pCD mod1 <. NS IN>
Aug 8 11:20:25 celje unbound: [6762:0] info: 1RDdc mod1 rep <. NS IN>
Aug 8 11:20:25 celje unbound: [6762:0] debug: cache memory msg=33040 rrset=33040 infra=1536 val=41428
Aug 8 11:20:25 celje unbound: [6762:0] debug: answer cb
Aug 8 11:20:25 celje unbound: [6762:0] debug: Incoming reply id = edef
Aug 8 11:20:25 celje unbound: [6762:0] debug: Incoming reply addr = ip4 192.36.148.17 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: lookup size is 1 entries
Aug 8 11:20:25 celje unbound: [6762:0] debug: received udp reply.
Aug 8 11:20:25 celje unbound: [6762:0] debug: udp message[857:0] EDEF84100001000E00000017000002000100000200010007E900001401690C726F6F742D73657276657273036E65740000000200010007E9000004016AC01E00000200010007E90000040168C01E00000200010007E90000040166C01E00000200010007E90000040164C01E00000200010007E90000040165C01E00000200010007E90000040163C01E00000200010007E90000040162C01E00000200010007E9000004016BC01E00000200010007E90000040167C01E00000200010007E9000004016DC01E00000200010007E90000040161C01E00000200010007E9000004016CC01E00002E00010007E9000093000208000007E9004E4861804E3F18F099
Aug 8 11:20:25 celje unbound: [6762:0] debug: udp message[857:256] 730086C8445044F339B9B29EDD9AE4EF3EDE8F6F261EA971E99DC239868B929FC29190F433B5FB3B80BC226AF8979B9BA489B41F96F6416B718F5071B3690DC5DAB6CC01F311AC3BE38DEFA13583B4938A085832B9D4B7A1D71C65C1D4F73FA3A09912ECF6149EE1C5273117A63C0AEAD24C0E700B780DCCB6F7719E959EAA84D34EC0D1000100010036EE800004C6290004C0D1001C00010036EE80001020010503BA3E00000000000000020030C095000100010036EE800004C0E44FC9C086000100010036EE800004C021040CC068000100010036EE80000480080A5AC068001C00010036EE80001020010500002D0000000000000000000DC07700010001
Aug 8 11:20:25 celje unbound: [6762:0] debug: udp message[857:512] 0036EE800004C0CBE60AC059000100010036EE800004C00505F1C059001C00010036EE80001020010500002F0000000000000000000FC0B3000100010036EE800004C0702404C04A000100010036EE800004803F0235C04A001C00010036EE800010200105000001000000000000803F0235C01C000100010036EE800004C0249411C01C001C00010036EE800010200107FE000000000000000000000053C03B000100010036EE800004C03A801EC03B001C00010036EE800010200105030C2700000000000000020030C0A4000100010036EE800004C1000E81C0A4001C00010036EE800010200107FD000000000000000000000001C0E0000100010036EE80
Aug 8 11:20:25 celje unbound: [6762:0] debug: udp message[857:768] 0004C707532AC0E0001C00010036EE80001020010500000300000000000000000042C0C2000100010036EE800004CA0C1B21C0C2001C00010036EE80001020010DC30000000000000000000000350000291000000080000000
Aug 8 11:20:25 celje unbound: [6762:0] debug: outnet handle udp reply
Aug 8 11:20:25 celje unbound: [6762:0] debug: serviced query: EDNS works for ip4 192.36.148.17 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: measured roundtrip at 118 msec
Aug 8 11:20:25 celje unbound: [6762:0] debug: svcd callbacks start
Aug 8 11:20:25 celje unbound: [6762:0] debug: worker svcd callback for qstate 0x94ff058
Aug 8 11:20:25 celje unbound: [6762:0] debug: mesh_run: start
Aug 8 11:20:25 celje unbound: [6762:0] debug: iterator[module 1] operate: extstate:module_wait_reply event:module_event_reply
Aug 8 11:20:25 celje unbound: [6762:0] info: iterator operate: query <. NS IN>
Aug 8 11:20:25 celje unbound: [6762:0] debug: process_response: new external response event
Aug 8 11:20:25 celje unbound: [6762:0] info: scrub for <. NS IN>
Aug 8 11:20:25 celje unbound: [6762:0] info: response for <. NS IN>
Aug 8 11:20:25 celje unbound: [6762:0] info: reply from <.> 192.36.148.17#53
Aug 8 11:20:25 celje unbound: [6762:0] info: incoming scrubbed packet: ;; ->>HEADER<<- opcode: QUERY, rcode: NOERROR, id: 0#012;; flags: qr aa ; QUERY: 1, ANSWER: 14, AUTHORITY: 0, ADDITIONAL: 22 #012;; QUESTION SECTION:#012;; .#011IN#011NS#012#012;; ANSWER SECTION:#012.#011518400#011IN#011NS#011i.root-servers.net.#012.#011518400#011IN#011NS#011j.root-servers.net.#012.#011518400#011IN#011NS#011h.root-servers.net.#012.#011518400#011IN#011NS#011f.root-servers.net.#012.#011518400#011IN#011NS#011d.root-servers.net.#012.#011518400#011IN#011NS#011e.root-servers.net.#012.#011518400#011IN#011NS#011c.root-servers.net.#012.#011518400#011IN#011NS#011b.root-servers.net.#012.#011518400#011IN#011NS#011k.root-servers.net.#012.#011518400#011IN#011NS#011g.root-servers.net.#012.#011518400#011IN#011NS#011m.root-servers.net.#012.#011518400#011IN#011NS#011a.root-servers.net.#012.#011518400#011IN#011NS#011l.root-servers.net.#012.#011518400#011IN#011RRSIG#011NS 8 0 518400 20110815000000 20110807230000 39283 . hshEUETzObmynt2a5O8+3o9vJh6pcemdwjmGi5KfwpGQ9DO1+zuAvCJq+Jebm6SJtB+W9kFrcY9QcbNpDcXatswB8xGsO+ON76E1g7STighYMrnUt6HXHGXB1Pc/o6CZEuz2FJ7hxScxF6Y8CurSTA5wC3gNzLb3cZ6VnqqE004= ;{id = 39283}#012#012;; AUTHORITY SECTION:#012#012;; ADDITIONAL SECTION:#012a.root-servers.net.#0113600000#011IN#011A#011198.41.0.4#012a.root-servers.net.#0113600000#011IN#011AAAA#0112001:503:ba3e::2:30#012b.root-servers.net.#0113600000#011IN#011A#011192.228.79.201#012c.root-servers.net.#0113600000#011IN#011A#011192.33.4.12#012d.root-servers.net.#0113600000#011IN#011A#011128.8.10.90#012d.root-servers.net.#0113600000#011IN#011AAAA#0112001:500:2d::d#012e.root-servers.net.#0113600000#011IN#011A#011192.203.230.10#012f.root-servers.net.#0113600000#011IN#011A#011192.5.5.241#012f.root-servers.net.#0113600000#011IN#011AAAA#0112001:500:2f::f#012g.root-servers.net.#0113600000#011IN#011A#011192.112.36.4#012h.root-servers.net.#0113600000#011IN#011A#011128.63.2.53#012h.root-servers.net.#0113600000#011IN#011AAAA#0112001:500:1::803f:235#012i.root-servers.net.#0113600000#011IN#011A#011192.36.148.17#012i.root-servers.net.#0113600000#011IN#011AAAA#0112001:7fe::53#012j.root-servers.net.#0113600000#011IN#011A#011192.58.128.30#012j.root-servers.net.#0113600000#011IN#011AAAA#0112001:503:c27::2:30#012k.root-servers.net.#0113600000#011IN#011A#011193.0.14.129#012k.root-servers.net.#0113600000#011IN#011AAAA#0112001:7fd::1#012l.root-servers.net.#0113600000#011IN#011A#011199.7.83.42#012l.root-servers.net.#0113600000#011IN#011AAAA#0112001:500:3::42#012m.root-servers.net.#0113600000#011IN#011A#011202.12.27.33#012m.root-servers.net.#0113600000#011IN#011AAAA#0112001:dc3::35#012#012;; Query time: 0 msec#012;; WHEN: Thu Jan 1 00:00:00 1970#012;; MSG SIZE rcvd: 846
Aug 8 11:20:25 celje unbound: [6762:0] debug: iter_handle processing q with state QUERY RESPONSE STATE
Aug 8 11:20:25 celje unbound: [6762:0] info: query response was ANSWER
Aug 8 11:20:25 celje unbound: [6762:0] debug: iter_handle processing q with state PRIME RESPONSE STATE
Aug 8 11:20:25 celje unbound: [6762:0] info: schedule prime validation <. NS IN>
Aug 8 11:20:25 celje unbound: [6762:0] debug: attach failed, cycle detected
Aug 8 11:20:25 celje unbound: [6762:0] debug: could not generate prime check
Aug 8 11:20:25 celje unbound: [6762:0] info: schedule addr fetch <a.root-servers.net. A IN>
Aug 8 11:20:25 celje unbound: [6762:0] info: schedule addr fetch <a.root-servers.net. AAAA IN>
Aug 8 11:20:25 celje unbound: [6762:0] info: schedule addr fetch <b.root-servers.net. A IN>
Aug 8 11:20:25 celje unbound: [6762:0] info: schedule addr fetch <c.root-servers.net. A IN>
Aug 8 11:20:25 celje unbound: [6762:0] info: schedule addr fetch <d.root-servers.net. A IN>
Aug 8 11:20:25 celje unbound: [6762:0] info: schedule addr fetch <d.root-servers.net. AAAA IN>
Aug 8 11:20:25 celje unbound: [6762:0] info: schedule addr fetch <e.root-servers.net. A IN>
Aug 8 11:20:25 celje unbound: [6762:0] info: schedule addr fetch <f.root-servers.net. A IN>
Aug 8 11:20:25 celje unbound: [6762:0] info: schedule addr fetch <f.root-servers.net. AAAA IN>
Aug 8 11:20:25 celje unbound: [6762:0] info: schedule addr fetch <g.root-servers.net. A IN>
Aug 8 11:20:25 celje unbound: [6762:0] info: schedule addr fetch <h.root-servers.net. A IN>
Aug 8 11:20:25 celje unbound: [6762:0] info: schedule addr fetch <h.root-servers.net. AAAA IN>
Aug 8 11:20:25 celje unbound: [6762:0] info: schedule addr fetch <i.root-servers.net. A IN>
Aug 8 11:20:25 celje unbound: [6762:0] info: schedule addr fetch <i.root-servers.net. AAAA IN>
Aug 8 11:20:25 celje unbound: [6762:0] info: schedule addr fetch <j.root-servers.net. A IN>
Aug 8 11:20:25 celje unbound: [6762:0] info: schedule addr fetch <j.root-servers.net. AAAA IN>
Aug 8 11:20:25 celje unbound: [6762:0] info: schedule addr fetch <k.root-servers.net. A IN>
Aug 8 11:20:25 celje unbound: [6762:0] info: schedule addr fetch <k.root-servers.net. AAAA IN>
Aug 8 11:20:25 celje unbound: [6762:0] info: schedule addr fetch <l.root-servers.net. A IN>
Aug 8 11:20:25 celje unbound: [6762:0] info: schedule addr fetch <l.root-servers.net. AAAA IN>
Aug 8 11:20:25 celje unbound: [6762:0] info: schedule addr fetch <m.root-servers.net. A IN>
Aug 8 11:20:25 celje unbound: [6762:0] info: schedule addr fetch <m.root-servers.net. AAAA IN>
Aug 8 11:20:25 celje unbound: [6762:0] debug: mesh_run: iterator module exit state is module_finished
Aug 8 11:20:25 celje unbound: [6762:0] debug: validator[module 0] operate: extstate:module_state_initial event:module_event_moddone
Aug 8 11:20:25 celje unbound: [6762:0] info: validator operate: query <. NS IN>
Aug 8 11:20:25 celje unbound: [6762:0] debug: validator: nextmodule returned
Aug 8 11:20:25 celje unbound: [6762:0] debug: not validating response due to CD bit
Aug 8 11:20:25 celje unbound: [6762:0] debug: mesh_run: validator module exit state is module_finished
Aug 8 11:20:25 celje unbound: [6762:0] info: priming successful for <. NS IN>
Aug 8 11:20:25 celje unbound: [6762:0] info: DelegationPoint<.>: 13 names (4 missing), 22 addrs (0 result, 22 avail) parentNS
Aug 8 11:20:25 celje unbound: [6762:0] info: l.root-servers.net. * A AAAA
Aug 8 11:20:25 celje unbound: [6762:0] info: a.root-servers.net. * A AAAA
Aug 8 11:20:25 celje unbound: [6762:0] info: m.root-servers.net. * A AAAA
Aug 8 11:20:25 celje unbound: [6762:0] info: g.root-servers.net. A
Aug 8 11:20:25 celje unbound: [6762:0] info: k.root-servers.net. * A AAAA
Aug 8 11:20:25 celje unbound: [6762:0] info: b.root-servers.net. A
Aug 8 11:20:25 celje unbound: [6762:0] info: c.root-servers.net. A
Aug 8 11:20:25 celje unbound: [6762:0] info: e.root-servers.net. A
Aug 8 11:20:25 celje unbound: [6762:0] info: d.root-servers.net. * A AAAA
Aug 8 11:20:25 celje unbound: [6762:0] info: f.root-servers.net. * A AAAA
Aug 8 11:20:25 celje unbound: [6762:0] info: h.root-servers.net. * A AAAA
Aug 8 11:20:25 celje unbound: [6762:0] info: j.root-servers.net. * A AAAA
Aug 8 11:20:25 celje unbound: [6762:0] info: i.root-servers.net. * A AAAA
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip6 2001:dc3::35 port 53 (len 28)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 202.12.27.33 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip6 2001:500:3::42 port 53 (len 28)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 199.7.83.42 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip6 2001:7fd::1 port 53 (len 28)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 193.0.14.129 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip6 2001:503:c27::2:30 port 53 (len 28)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 192.58.128.30 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip6 2001:7fe::53 port 53 (len 28)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 192.36.148.17 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip6 2001:500:1::803f:235 port 53 (len 28)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 128.63.2.53 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 192.112.36.4 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip6 2001:500:2f::f port 53 (len 28)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 192.5.5.241 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 192.203.230.10 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip6 2001:500:2d::d port 53 (len 28)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 128.8.10.90 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 192.33.4.12 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 192.228.79.201 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip6 2001:503:ba3e::2:30 port 53 (len 28)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 198.41.0.4 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: iterator[module 1] operate: extstate:module_state_initial event:module_event_pass
Aug 8 11:20:25 celje unbound: [6762:0] info: iterator operate: query <h.root-servers.net. A IN>
Aug 8 11:20:25 celje unbound: [6762:0] debug: iter_handle processing q with state INIT REQUEST STATE
Aug 8 11:20:25 celje unbound: [6762:0] info: resolving <h.root-servers.net. A IN>
Aug 8 11:20:25 celje unbound: [6762:0] debug: request has dependency depth of 2
Aug 8 11:20:25 celje unbound: [6762:0] debug: cache delegation returns delegpt
Aug 8 11:20:25 celje unbound: [6762:0] info: DelegationPoint<.>: 13 names (4 missing), 22 addrs (0 result, 22 avail) cacheNS
Aug 8 11:20:25 celje unbound: [6762:0] info: l.root-servers.net. * A AAAA
Aug 8 11:20:25 celje unbound: [6762:0] info: a.root-servers.net. * A AAAA
Aug 8 11:20:25 celje unbound: [6762:0] info: m.root-servers.net. * A AAAA
Aug 8 11:20:25 celje unbound: [6762:0] info: g.root-servers.net. A
Aug 8 11:20:25 celje unbound: [6762:0] info: k.root-servers.net. * A AAAA
Aug 8 11:20:25 celje unbound: [6762:0] info: b.root-servers.net. A
Aug 8 11:20:25 celje unbound: [6762:0] info: c.root-servers.net. A
Aug 8 11:20:25 celje unbound: [6762:0] info: e.root-servers.net. A
Aug 8 11:20:25 celje unbound: [6762:0] info: d.root-servers.net. * A AAAA
Aug 8 11:20:25 celje unbound: [6762:0] info: f.root-servers.net. * A AAAA
Aug 8 11:20:25 celje unbound: [6762:0] info: h.root-servers.net. * A AAAA
Aug 8 11:20:25 celje unbound: [6762:0] info: j.root-servers.net. * A AAAA
Aug 8 11:20:25 celje unbound: [6762:0] info: i.root-servers.net. * A AAAA
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip6 2001:7fe::53 port 53 (len 28)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 192.36.148.17 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip6 2001:503:c27::2:30 port 53 (len 28)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 192.58.128.30 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip6 2001:500:1::803f:235 port 53 (len 28)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 128.63.2.53 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip6 2001:500:2f::f port 53 (len 28)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 192.5.5.241 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip6 2001:500:2d::d port 53 (len 28)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 128.8.10.90 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 192.203.230.10 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 192.33.4.12 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 192.228.79.201 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip6 2001:7fd::1 port 53 (len 28)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 193.0.14.129 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 192.112.36.4 port 53 (len 16)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip6 2001:dc3::35 port 53 (len 28)
Aug 8 11:20:25 celje unbound: [6762:0] debug: ip4 202.12.27.33 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: timeout udp
Aug 8 11:20:31 celje unbound: [6762:0] debug: svcd callbacks start
Aug 8 11:20:31 celje unbound: [6762:0] debug: worker svcd callback for qstate 0x94db010
Aug 8 11:20:31 celje unbound: [6762:0] debug: mesh_run: start
Aug 8 11:20:31 celje unbound: [6762:0] debug: iterator[module 1] operate: extstate:module_wait_reply event:module_event_noreply
Aug 8 11:20:31 celje unbound: [6762:0] info: iterator operate: query <f.root-servers.net. AAAA IN>
Aug 8 11:20:31 celje unbound: [6762:0] debug: process_response: new external response event
Aug 8 11:20:31 celje unbound: [6762:0] debug: iter_handle processing q with state QUERY RESPONSE STATE
Aug 8 11:20:31 celje unbound: [6762:0] debug: query response was timeout
Aug 8 11:20:31 celje unbound: [6762:0] debug: iter_handle processing q with state QUERY TARGETS STATE
Aug 8 11:20:31 celje unbound: [6762:0] info: processQueryTargets: <f.root-servers.net. AAAA IN>
Aug 8 11:20:31 celje unbound: [6762:0] debug: processQueryTargets: targetqueries 0, currentqueries 0
Aug 8 11:20:31 celje unbound: [6762:0] info: DelegationPoint<.>: 13 names (0 missing), 22 addrs (22 result, 0 avail) cacheNS
Aug 8 11:20:31 celje unbound: [6762:0] info: l.root-servers.net. * A AAAA
Aug 8 11:20:31 celje unbound: [6762:0] info: a.root-servers.net. * A AAAA
Aug 8 11:20:31 celje unbound: [6762:0] info: m.root-servers.net. * A AAAA
Aug 8 11:20:31 celje unbound: [6762:0] info: g.root-servers.net. * A
Aug 8 11:20:31 celje unbound: [6762:0] info: k.root-servers.net. * A AAAA
Aug 8 11:20:31 celje unbound: [6762:0] info: b.root-servers.net. * A
Aug 8 11:20:31 celje unbound: [6762:0] info: c.root-servers.net. * A
Aug 8 11:20:31 celje unbound: [6762:0] info: e.root-servers.net. * A
Aug 8 11:20:31 celje unbound: [6762:0] info: d.root-servers.net. * A AAAA
Aug 8 11:20:31 celje unbound: [6762:0] info: f.root-servers.net. * A AAAA
Aug 8 11:20:31 celje unbound: [6762:0] info: h.root-servers.net. * A AAAA
Aug 8 11:20:31 celje unbound: [6762:0] info: j.root-servers.net. * A AAAA
Aug 8 11:20:31 celje unbound: [6762:0] info: i.root-servers.net. * A AAAA
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip6 2001:7fe::53 port 53 (len 28)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip4 192.36.148.17 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip6 2001:503:c27::2:30 port 53 (len 28)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip4 192.58.128.30 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip6 2001:500:1::803f:235 port 53 (len 28)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip4 128.63.2.53 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip6 2001:500:2f::f port 53 (len 28)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip4 192.5.5.241 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip6 2001:500:2d::d port 53 (len 28)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip4 128.8.10.90 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip4 192.203.230.10 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip4 192.33.4.12 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip4 192.228.79.201 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip6 2001:7fd::1 port 53 (len 28)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip4 193.0.14.129 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip4 192.112.36.4 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip6 2001:dc3::35 port 53 (len 28)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip4 202.12.27.33 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip6 2001:503:ba3e::2:30 port 53 (len 28)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip4 198.41.0.4 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip6 2001:500:3::42 port 53 (len 28)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip4 199.7.83.42 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: attempt to get extra 1 targets
Aug 8 11:20:31 celje unbound: [6762:0] debug: servselect ip4 192.36.148.17 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: rtt=3312
Aug 8 11:20:31 celje unbound: [6762:0] debug: servselect ip4 192.228.79.201 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: rtt=3008
Aug 8 11:20:31 celje unbound: [6762:0] debug: servselect ip4 128.63.2.53 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: rtt=3008
Aug 8 11:20:31 celje unbound: [6762:0] debug: servselect ip4 128.8.10.90 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: rtt=1504
Aug 8 11:20:31 celje unbound: [6762:0] debug: servselect ip4 192.33.4.12 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: rtt=3008
Aug 8 11:20:31 celje unbound: [6762:0] debug: servselect ip4 193.0.14.129 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: rtt=3008
Aug 8 11:20:31 celje unbound: [6762:0] debug: servselect ip4 198.41.0.4 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: rtt=3008
Aug 8 11:20:31 celje unbound: [6762:0] debug: servselect ip4 199.7.83.42 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: rtt=3008
Aug 8 11:20:31 celje unbound: [6762:0] debug: servselect ip4 202.12.27.33 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: rtt=3008
Aug 8 11:20:31 celje unbound: [6762:0] debug: servselect ip4 192.203.230.10 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: rtt=3008
Aug 8 11:20:31 celje unbound: [6762:0] debug: servselect ip4 192.58.128.30 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: rtt=3008
Aug 8 11:20:31 celje unbound: [6762:0] debug: servselect ip4 192.5.5.241 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: rtt=3008
Aug 8 11:20:31 celje unbound: [6762:0] debug: servselect ip4 192.112.36.4 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: rtt=3008
Aug 8 11:20:31 celje unbound: [6762:0] debug: selrtt 1504
Aug 8 11:20:31 celje unbound: [6762:0] info: sending query: <f.root-servers.net. AAAA IN>
Aug 8 11:20:31 celje unbound: [6762:0] debug: sending to target: <.> 128.8.10.90#53
Aug 8 11:20:31 celje unbound: [6762:0] debug: dnssec status: not expected
Aug 8 11:20:31 celje unbound: [6762:0] debug: EDNS lookup known=0 vs=0
Aug 8 11:20:31 celje unbound: [6762:0] debug: serviced query UDP timeout=1504 msec
Aug 8 11:20:31 celje unbound: [6762:0] debug: inserted new pending reply id=3100
Aug 8 11:20:31 celje unbound: [6762:0] debug: opened UDP if=0 port=37018
Aug 8 11:20:31 celje unbound: [6762:0] debug: comm point start listening 16
Aug 8 11:20:31 celje unbound: [6762:0] debug: mesh_run: iterator module exit state is module_wait_reply
Aug 8 11:20:31 celje unbound: [6762:0] info: mesh_run: end 23 recursion states (1 with reply, 22 detached), 1 waiting replies, 0 recursion replies sent, 0 replies dropped, 0 states jostled out
Aug 8 11:20:31 celje unbound: [6762:0] info: 0RDd mod1 <a.root-servers.net. A IN>
Aug 8 11:20:31 celje unbound: [6762:0] info: 1RDd mod1 <b.root-servers.net. A IN>
Aug 8 11:20:31 celje unbound: [6762:0] info: 2RDd mod1 <c.root-servers.net. A IN>
Aug 8 11:20:31 celje unbound: [6762:0] info: 3RDd mod1 <d.root-servers.net. A IN>
Aug 8 11:20:31 celje unbound: [6762:0] info: 4RDd mod1 <e.root-servers.net. A IN>
Aug 8 11:20:31 celje unbound: [6762:0] info: 5RDd mod1 <f.root-servers.net. A IN>
Aug 8 11:20:31 celje unbound: [6762:0] info: 6RDd mod1 <g.root-servers.net. A IN>
Aug 8 11:20:31 celje unbound: [6762:0] info: 7RDd mod1 <h.root-servers.net. A IN>
Aug 8 11:20:31 celje unbound: [6762:0] info: 8RDd mod1 <i.root-servers.net. A IN>
Aug 8 11:20:31 celje unbound: [6762:0] info: 9RDd mod1 <j.root-servers.net. A IN>
Aug 8 11:20:31 celje unbound: [6762:0] info: 10RDd mod1 <k.root-servers.net. A IN>
Aug 8 11:20:31 celje unbound: [6762:0] info: 11RDd mod1 <l.root-servers.net. A IN>
Aug 8 11:20:31 celje unbound: [6762:0] info: 12RDd mod1 <m.root-servers.net. A IN>
Aug 8 11:20:31 celje unbound: [6762:0] info: 13RDd mod1 rep <. NS IN>
Aug 8 11:20:31 celje unbound: [6762:0] info: 14RDd mod1 <a.root-servers.net. AAAA IN>
Aug 8 11:20:31 celje unbound: [6762:0] info: 15RDd mod1 <d.root-servers.net. AAAA IN>
Aug 8 11:20:31 celje unbound: [6762:0] info: 16RDd mod1 <f.root-servers.net. AAAA IN>
Aug 8 11:20:31 celje unbound: [6762:0] info: 17RDd mod1 <h.root-servers.net. AAAA IN>
Aug 8 11:20:31 celje unbound: [6762:0] info: 18RDd mod1 <i.root-servers.net. AAAA IN>
Aug 8 11:20:31 celje unbound: [6762:0] info: 19RDd mod1 <j.root-servers.net. AAAA IN>
Aug 8 11:20:31 celje unbound: [6762:0] info: 20RDd mod1 <k.root-servers.net. AAAA IN>
Aug 8 11:20:31 celje unbound: [6762:0] info: 21RDd mod1 <l.root-servers.net. AAAA IN>
Aug 8 11:20:31 celje unbound: [6762:0] info: 22RDd mod1 <m.root-servers.net. AAAA IN>
Aug 8 11:20:31 celje unbound: [6762:0] debug: cache memory msg=33517 rrset=37164 infra=4176 val=41428
Aug 8 11:20:31 celje unbound: [6762:0] debug: svcd callbacks end
Aug 8 11:20:31 celje unbound: [6762:0] debug: close of port 55497
Aug 8 11:20:31 celje unbound: [6762:0] debug: close fd 21
Aug 8 11:20:31 celje unbound: [6762:0] debug: timeout udp
Aug 8 11:20:31 celje unbound: [6762:0] debug: svcd callbacks start
Aug 8 11:20:31 celje unbound: [6762:0] debug: worker svcd callback for qstate 0x94aafb0
Aug 8 11:20:31 celje unbound: [6762:0] debug: mesh_run: start
Aug 8 11:20:31 celje unbound: [6762:0] debug: iterator[module 1] operate: extstate:module_wait_reply event:module_event_noreply
Aug 8 11:20:31 celje unbound: [6762:0] info: iterator operate: query <m.root-servers.net. A IN>
Aug 8 11:20:31 celje unbound: [6762:0] debug: process_response: new external response event
Aug 8 11:20:31 celje unbound: [6762:0] debug: iter_handle processing q with state QUERY RESPONSE STATE
Aug 8 11:20:31 celje unbound: [6762:0] debug: query response was timeout
Aug 8 11:20:31 celje unbound: [6762:0] debug: iter_handle processing q with state QUERY TARGETS STATE
Aug 8 11:20:31 celje unbound: [6762:0] info: processQueryTargets: <m.root-servers.net. A IN>
Aug 8 11:20:31 celje unbound: [6762:0] debug: processQueryTargets: targetqueries 0, currentqueries 0
Aug 8 11:20:31 celje unbound: [6762:0] info: DelegationPoint<.>: 13 names (0 missing), 22 addrs (22 result, 0 avail) cacheNS
Aug 8 11:20:31 celje unbound: [6762:0] info: l.root-servers.net. * A AAAA
Aug 8 11:20:31 celje unbound: [6762:0] info: a.root-servers.net. * A AAAA
Aug 8 11:20:31 celje unbound: [6762:0] info: m.root-servers.net. * A AAAA
Aug 8 11:20:31 celje unbound: [6762:0] info: g.root-servers.net. * A
Aug 8 11:20:31 celje unbound: [6762:0] info: k.root-servers.net. * A AAAA
Aug 8 11:20:31 celje unbound: [6762:0] info: b.root-servers.net. * A
Aug 8 11:20:31 celje unbound: [6762:0] info: c.root-servers.net. * A
Aug 8 11:20:31 celje unbound: [6762:0] info: e.root-servers.net. * A
Aug 8 11:20:31 celje unbound: [6762:0] info: d.root-servers.net. * A AAAA
Aug 8 11:20:31 celje unbound: [6762:0] info: f.root-servers.net. * A AAAA
Aug 8 11:20:31 celje unbound: [6762:0] info: h.root-servers.net. * A AAAA
Aug 8 11:20:31 celje unbound: [6762:0] info: j.root-servers.net. * A AAAA
Aug 8 11:20:31 celje unbound: [6762:0] info: i.root-servers.net. * A AAAA
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip6 2001:7fe::53 port 53 (len 28)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip4 192.36.148.17 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip6 2001:503:c27::2:30 port 53 (len 28)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip4 192.58.128.30 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip6 2001:500:1::803f:235 port 53 (len 28)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip4 128.63.2.53 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip6 2001:500:2f::f port 53 (len 28)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip4 192.5.5.241 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip6 2001:500:2d::d port 53 (len 28)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip4 128.8.10.90 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip4 192.203.230.10 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip4 192.33.4.12 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip4 192.228.79.201 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip6 2001:7fd::1 port 53 (len 28)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip4 193.0.14.129 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip4 192.112.36.4 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip6 2001:dc3::35 port 53 (len 28)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip4 202.12.27.33 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip6 2001:503:ba3e::2:30 port 53 (len 28)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip4 198.41.0.4 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip6 2001:500:3::42 port 53 (len 28)
Aug 8 11:20:31 celje unbound: [6762:0] debug: ip4 199.7.83.42 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: attempt to get extra 1 targets
Aug 8 11:20:31 celje unbound: [6762:0] debug: servselect ip4 192.36.148.17 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: rtt=3312
Aug 8 11:20:31 celje unbound: [6762:0] debug: servselect ip4 192.228.79.201 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: rtt=3008
Aug 8 11:20:31 celje unbound: [6762:0] debug: servselect ip4 192.33.4.12 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: rtt=3008
Aug 8 11:20:31 celje unbound: [6762:0] debug: servselect ip4 192.5.5.241 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: rtt=3008
Aug 8 11:20:31 celje unbound: [6762:0] debug: servselect ip4 128.63.2.53 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: rtt=3008
Aug 8 11:20:31 celje unbound: [6762:0] debug: servselect ip4 128.8.10.90 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: rtt=1504
Aug 8 11:20:31 celje unbound: [6762:0] debug: servselect ip4 193.0.14.129 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: rtt=3008
Aug 8 11:20:31 celje unbound: [6762:0] debug: servselect ip4 198.41.0.4 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: rtt=3008
Aug 8 11:20:31 celje unbound: [6762:0] debug: servselect ip4 199.7.83.42 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: rtt=3008
Aug 8 11:20:31 celje unbound: [6762:0] debug: servselect ip4 202.12.27.33 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: rtt=3008
Aug 8 11:20:31 celje unbound: [6762:0] debug: servselect ip4 192.203.230.10 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: rtt=3008
Aug 8 11:20:31 celje unbound: [6762:0] debug: servselect ip4 192.58.128.30 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: rtt=3008
Aug 8 11:20:31 celje unbound: [6762:0] debug: servselect ip4 192.112.36.4 port 53 (len 16)
Aug 8 11:20:31 celje unbound: [6762:0] debug: rtt=3008
Aug 8 11:20:31 celje unbound: [6762:0] debug: selrtt 1504
Aug 8 11:20:31 celje unbound: [6762:0] info: sending query: <m.root-servers.net. A IN>
Aug 8 11:20:31 celje unbound: [6762:0] debug: sending to target: <.> 128.8.10.90#53
Aug 8 11:20:31 celje unbound: [6762:0] debug: dnssec status: not expected
Aug 8 11:20:31 celje unbound: [6762:0] debug: EDNS lookup known=0 vs=0
Aug 8 11:20:31 celje unbound: [6762:0] debug: serviced query UDP timeout=1504 msec
Aug 8 11:20:31 celje unbound: [6762:0] debug: inserted new pending reply id=4a01
Aug 8 11:20:31 celje unbound: [6762:0] debug: opened UDP if=0 port=23362
Aug 8 11:20:31 celje unbound: [6762:0] debug: comm point start listening 21
Aug 8 11:20:31 celje unbound: [6762:0] debug: mesh_run: iterator module exit state is module_wait_reply
Aug 8 11:20:31 celje unbound: [6762:0] info: mesh_run: end 23 recursion states (1 with reply, 22 detached), 1 waiting replies, 0 recursion replies sent, 0 replies dropped, 0 states jostled out
Aug 8 11:20:31 celje unbound: [6762:0] info: 0RDd mod1 <a.root-servers.net. A IN>
Aug 8 11:20:37 celje unbound: [6762:0] debug: timeout udp
Aug 8 11:20:37 celje unbound: [6762:0] debug: svcd callbacks start
Aug 8 11:20:37 celje unbound: [6762:0] debug: worker svcd callback for qstate 0x94befd8
Aug 8 11:20:37 celje unbound: [6762:0] debug: mesh_run: start
Aug 8 11:20:37 celje unbound: [6762:0] debug: iterator[module 1] operate: extstate:module_wait_reply event:module_event_noreply
Aug 8 11:20:37 celje unbound: [6762:0] info: iterator operate: query <j.root-servers.net. AAAA IN>
Aug 8 11:20:37 celje unbound: [6762:0] debug: process_response: new external response event
Aug 8 11:20:37 celje unbound: [6762:0] debug: iter_handle processing q with state QUERY RESPONSE STATE
Aug 8 11:20:37 celje unbound: [6762:0] debug: query response was timeout
Aug 8 11:20:37 celje unbound: [6762:0] debug: iter_handle processing q with state QUERY TARGETS STATE
Aug 8 11:20:37 celje unbound: [6762:0] info: processQueryTargets: <j.root-servers.net. AAAA IN>
Aug 8 11:20:37 celje unbound: [6762:0] debug: processQueryTargets: targetqueries 0, currentqueries 0
Aug 8 11:20:37 celje unbound: [6762:0] info: DelegationPoint<.>: 13 names (0 missing), 22 addrs (22 result, 0 avail) cacheNS
Aug 8 11:20:37 celje unbound: [6762:0] info: l.root-servers.net. * A AAAA
Aug 8 11:20:37 celje unbound: [6762:0] info: a.root-servers.net. * A AAAA
Aug 8 11:20:37 celje unbound: [6762:0] info: m.root-servers.net. * A AAAA
Aug 8 11:20:37 celje unbound: [6762:0] info: g.root-servers.net. * A
Aug 8 11:20:37 celje unbound: [6762:0] info: k.root-servers.net. * A AAAA
Aug 8 11:20:37 celje unbound: [6762:0] info: b.root-servers.net. * A
Aug 8 11:20:37 celje unbound: [6762:0] info: c.root-servers.net. * A
Aug 8 11:20:37 celje unbound: [6762:0] info: e.root-servers.net. * A
Aug 8 11:20:37 celje unbound: [6762:0] info: d.root-servers.net. * A AAAA
Aug 8 11:20:37 celje unbound: [6762:0] info: f.root-servers.net. * A AAAA
Aug 8 11:20:37 celje unbound: [6762:0] info: h.root-servers.net. * A AAAA
Aug 8 11:20:37 celje unbound: [6762:0] info: j.root-servers.net. * A AAAA
Aug 8 11:20:37 celje unbound: [6762:0] info: i.root-servers.net. * A AAAA
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip6 2001:7fe::53 port 53 (len 28)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip4 192.36.148.17 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip6 2001:503:c27::2:30 port 53 (len 28)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip4 192.58.128.30 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip6 2001:500:1::803f:235 port 53 (len 28)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip4 128.63.2.53 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip6 2001:500:2f::f port 53 (len 28)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip4 192.5.5.241 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip6 2001:500:2d::d port 53 (len 28)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip4 128.8.10.90 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip4 192.203.230.10 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip4 192.33.4.12 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip4 192.228.79.201 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip6 2001:7fd::1 port 53 (len 28)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip4 193.0.14.129 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip4 192.112.36.4 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip6 2001:dc3::35 port 53 (len 28)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip4 202.12.27.33 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip6 2001:503:ba3e::2:30 port 53 (len 28)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip4 198.41.0.4 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip6 2001:500:3::42 port 53 (len 28)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip4 199.7.83.42 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: attempt to get extra 1 targets
Aug 8 11:20:37 celje unbound: [6762:0] debug: servselect ip4 192.228.79.201 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: rtt=3008
Aug 8 11:20:37 celje unbound: [6762:0] debug: servselect ip4 128.8.10.90 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: rtt=6016
Aug 8 11:20:37 celje unbound: [6762:0] debug: servselect ip4 193.0.14.129 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: rtt=6016
Aug 8 11:20:37 celje unbound: [6762:0] debug: servselect ip4 199.7.83.42 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: rtt=6016
Aug 8 11:20:37 celje unbound: [6762:0] debug: servselect ip4 198.41.0.4 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: rtt=6016
Aug 8 11:20:37 celje unbound: [6762:0] debug: servselect ip4 192.203.230.10 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: rtt=6016
Aug 8 11:20:37 celje unbound: [6762:0] debug: servselect ip4 192.58.128.30 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: rtt=6016
Aug 8 11:20:37 celje unbound: [6762:0] debug: servselect ip4 192.5.5.241 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: rtt=6016
Aug 8 11:20:37 celje unbound: [6762:0] debug: servselect ip4 192.33.4.12 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: rtt=6016
Aug 8 11:20:37 celje unbound: [6762:0] debug: servselect ip4 192.112.36.4 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: rtt=6016
Aug 8 11:20:37 celje unbound: [6762:0] debug: servselect ip4 192.36.148.17 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: rtt=6624
Aug 8 11:20:37 celje unbound: [6762:0] debug: servselect ip4 202.12.27.33 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: rtt=6016
Aug 8 11:20:37 celje unbound: [6762:0] debug: servselect ip4 128.63.2.53 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: rtt=6016
Aug 8 11:20:37 celje unbound: [6762:0] debug: selrtt 3008
Aug 8 11:20:37 celje unbound: [6762:0] info: sending query: <j.root-servers.net. AAAA IN>
Aug 8 11:20:37 celje unbound: [6762:0] debug: sending to target: <.> 192.228.79.201#53
Aug 8 11:20:37 celje unbound: [6762:0] debug: dnssec status: not expected
Aug 8 11:20:37 celje unbound: [6762:0] debug: EDNS lookup known=0 vs=0
Aug 8 11:20:37 celje unbound: [6762:0] debug: serviced query UDP timeout=3008 msec
Aug 8 11:20:37 celje unbound: [6762:0] debug: inserted new pending reply id=7ff1
Aug 8 11:20:37 celje unbound: [6762:0] debug: opened UDP if=0 port=56619
Aug 8 11:20:37 celje unbound: [6762:0] debug: comm point start listening 21
Aug 8 11:20:37 celje unbound: [6762:0] debug: mesh_run: iterator module exit state is module_wait_reply
Aug 8 11:20:37 celje unbound: [6762:0] info: mesh_run: end 23 recursion states (1 with reply, 22 detached), 2 waiting replies, 0 recursion replies sent, 0 replies dropped, 0 states jostled out
Aug 8 11:20:37 celje unbound: [6762:0] info: 0RDd mod1 <a.root-servers.net. A IN>
Aug 8 11:20:37 celje unbound: [6762:0] info: 1RDd mod1 <b.root-servers.net. A IN>
Aug 8 11:20:37 celje unbound: [6762:0] info: 2RDd mod1 <c.root-servers.net. A IN>
Aug 8 11:20:37 celje unbound: [6762:0] info: 3RDd mod1 <d.root-servers.net. A IN>
Aug 8 11:20:37 celje unbound: [6762:0] info: 4RDd mod1 <e.root-servers.net. A IN>
Aug 8 11:20:37 celje unbound: [6762:0] info: 5RDd mod1 <f.root-servers.net. A IN>
Aug 8 11:20:37 celje unbound: [6762:0] info: 6RDd mod1 <g.root-servers.net. A IN>
Aug 8 11:20:37 celje unbound: [6762:0] info: 7RDd mod1 <h.root-servers.net. A IN>
Aug 8 11:20:37 celje unbound: [6762:0] info: 8RDd mod1 <i.root-servers.net. A IN>
Aug 8 11:20:37 celje unbound: [6762:0] info: 9RDd mod1 <j.root-servers.net. A IN>
Aug 8 11:20:37 celje unbound: [6762:0] info: 10RDd mod1 <k.root-servers.net. A IN>
Aug 8 11:20:37 celje unbound: [6762:0] info: 11RDd mod1 <l.root-servers.net. A IN>
Aug 8 11:20:37 celje unbound: [6762:0] info: 12RDd mod1 <m.root-servers.net. A IN>
Aug 8 11:20:37 celje unbound: [6762:0] info: 13RDd mod1 rep <. NS IN>
Aug 8 11:20:37 celje unbound: [6762:0] info: 14RDd mod1 <a.root-servers.net. AAAA IN>
Aug 8 11:20:37 celje unbound: [6762:0] info: 15RDd mod1 <d.root-servers.net. AAAA IN>
Aug 8 11:20:37 celje unbound: [6762:0] info: 16RDd mod1 <f.root-servers.net. AAAA IN>
Aug 8 11:20:37 celje unbound: [6762:0] info: 17RDd mod1 <h.root-servers.net. AAAA IN>
Aug 8 11:20:37 celje unbound: [6762:0] info: 18RDd mod1 <i.root-servers.net. AAAA IN>
Aug 8 11:20:37 celje unbound: [6762:0] info: 19RDd mod1 <j.root-servers.net. AAAA IN>
Aug 8 11:20:37 celje unbound: [6762:0] info: 20RDd mod1 <k.root-servers.net. AAAA IN>
Aug 8 11:20:37 celje unbound: [6762:0] info: 21RDd mod1 <l.root-servers.net. AAAA IN>
Aug 8 11:20:37 celje unbound: [6762:0] info: 22RDd mod1 <m.root-servers.net. AAAA IN>
Aug 8 11:20:37 celje unbound: [6762:0] debug: cache memory msg=33517 rrset=37164 infra=4176 val=41428
Aug 8 11:20:37 celje unbound: [6762:0] debug: svcd callbacks end
Aug 8 11:20:37 celje unbound: [6762:0] debug: close of port 61794
Aug 8 11:20:37 celje unbound: [6762:0] debug: close fd 17
Aug 8 11:20:37 celje unbound: [6762:0] debug: timeout udp
Aug 8 11:20:37 celje unbound: [6762:0] debug: svcd callbacks start
Aug 8 11:20:37 celje unbound: [6762:0] debug: worker svcd callback for qstate 0x94bafd0
Aug 8 11:20:37 celje unbound: [6762:0] debug: mesh_run: start
Aug 8 11:20:37 celje unbound: [6762:0] debug: iterator[module 1] operate: extstate:module_wait_reply event:module_event_noreply
Aug 8 11:20:37 celje unbound: [6762:0] info: iterator operate: query <k.root-servers.net. A IN>
Aug 8 11:20:37 celje unbound: [6762:0] debug: process_response: new external response event
Aug 8 11:20:37 celje unbound: [6762:0] debug: iter_handle processing q with state QUERY RESPONSE STATE
Aug 8 11:20:37 celje unbound: [6762:0] debug: query response was timeout
Aug 8 11:20:37 celje unbound: [6762:0] debug: iter_handle processing q with state QUERY TARGETS STATE
Aug 8 11:20:37 celje unbound: [6762:0] info: processQueryTargets: <k.root-servers.net. A IN>
Aug 8 11:20:37 celje unbound: [6762:0] debug: processQueryTargets: targetqueries 0, currentqueries 0
Aug 8 11:20:37 celje unbound: [6762:0] info: DelegationPoint<.>: 13 names (0 missing), 22 addrs (22 result, 0 avail) cacheNS
Aug 8 11:20:37 celje unbound: [6762:0] info: l.root-servers.net. * A AAAA
Aug 8 11:20:37 celje unbound: [6762:0] info: a.root-servers.net. * A AAAA
Aug 8 11:20:37 celje unbound: [6762:0] info: m.root-servers.net. * A AAAA
Aug 8 11:20:37 celje unbound: [6762:0] info: g.root-servers.net. * A
Aug 8 11:20:37 celje unbound: [6762:0] info: k.root-servers.net. * A AAAA
Aug 8 11:20:37 celje unbound: [6762:0] info: b.root-servers.net. * A
Aug 8 11:20:37 celje unbound: [6762:0] info: c.root-servers.net. * A
Aug 8 11:20:37 celje unbound: [6762:0] info: e.root-servers.net. * A
Aug 8 11:20:37 celje unbound: [6762:0] info: d.root-servers.net. * A AAAA
Aug 8 11:20:37 celje unbound: [6762:0] info: f.root-servers.net. * A AAAA
Aug 8 11:20:37 celje unbound: [6762:0] info: h.root-servers.net. * A AAAA
Aug 8 11:20:37 celje unbound: [6762:0] info: j.root-servers.net. * A AAAA
Aug 8 11:20:37 celje unbound: [6762:0] info: i.root-servers.net. * A AAAA
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip6 2001:7fe::53 port 53 (len 28)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip4 192.36.148.17 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip6 2001:503:c27::2:30 port 53 (len 28)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip4 192.58.128.30 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip6 2001:500:1::803f:235 port 53 (len 28)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip4 128.63.2.53 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip6 2001:500:2f::f port 53 (len 28)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip4 192.5.5.241 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip6 2001:500:2d::d port 53 (len 28)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip4 128.8.10.90 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip4 192.203.230.10 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip4 192.33.4.12 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip4 192.228.79.201 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip6 2001:7fd::1 port 53 (len 28)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip4 193.0.14.129 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip4 192.112.36.4 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip6 2001:dc3::35 port 53 (len 28)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip4 202.12.27.33 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip6 2001:503:ba3e::2:30 port 53 (len 28)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip4 198.41.0.4 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip6 2001:500:3::42 port 53 (len 28)
Aug 8 11:20:37 celje unbound: [6762:0] debug: ip4 199.7.83.42 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: attempt to get extra 1 targets
Aug 8 11:20:37 celje unbound: [6762:0] debug: servselect ip4 128.8.10.90 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: rtt=6016
Aug 8 11:20:37 celje unbound: [6762:0] debug: servselect ip4 192.228.79.201 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: rtt=3008
Aug 8 11:20:37 celje unbound: [6762:0] debug: servselect ip4 193.0.14.129 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: rtt=6016
Aug 8 11:20:37 celje unbound: [6762:0] debug: servselect ip4 192.203.230.10 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: rtt=6016
Aug 8 11:20:37 celje unbound: [6762:0] debug: servselect ip4 192.33.4.12 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: rtt=6016
Aug 8 11:20:37 celje unbound: [6762:0] debug: servselect ip4 192.5.5.241 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: rtt=6016
Aug 8 11:20:37 celje unbound: [6762:0] debug: servselect ip4 192.58.128.30 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: rtt=6016
Aug 8 11:20:37 celje unbound: [6762:0] debug: servselect ip4 192.36.148.17 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: rtt=6624
Aug 8 11:20:37 celje unbound: [6762:0] debug: servselect ip4 192.112.36.4 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: rtt=6016
Aug 8 11:20:37 celje unbound: [6762:0] debug: servselect ip4 128.63.2.53 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: rtt=6016
Aug 8 11:20:37 celje unbound: [6762:0] debug: servselect ip4 199.7.83.42 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: rtt=6016
Aug 8 11:20:37 celje unbound: [6762:0] debug: servselect ip4 198.41.0.4 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: rtt=6016
Aug 8 11:20:37 celje unbound: [6762:0] debug: servselect ip4 202.12.27.33 port 53 (len 16)
Aug 8 11:20:37 celje unbound: [6762:0] debug: rtt=6016
Aug 8 11:20:37 celje unbound: [6762:0] debug: selrtt 3008
Aug 8 11:20:37 celje unbound: [6762:0] info: sending query: <k.root-servers.net. A IN>
Aug 8 11:20:37 celje unbound: [6762:0] debug: sending to target: <.> 192.228.79.201#53
Aug 8 11:20:37 celje unbound: [6762:0] debug: dnssec status: not expected
Aug 8 11:20:37 celje unbound: [6762:0] debug: EDNS lookup known=0 vs=0
Aug 8 11:20:37 celje unbound: [6762:0] debug: serviced query UDP timeout=3008 msec
Aug 8 11:20:37 celje unbound: [6762:0] debug: inserted new pending reply id=7811
Aug 8 11:20:37 celje unbound: [6762:0] debug: opened UDP if=0 port=22667
Aug 8 11:20:37 celje unbound: [6762:0] debug: comm point start listening 17
Aug 8 11:20:37 celje unbound: [6762:0] debug: mesh_run: iterator module exit state is module_wait_reply
Aug 8 11:20:37 celje unbound: [6762:0] info: mesh_run: end 23 recursion states (1 with reply, 22 detached), 2 waiting replies, 0 recursion replies sent, 0 replies dropped, 0 states jostled out
Aug 8 11:20:37 celje unbound: [6762:0] info: 0RDd mod1 <a.root-servers.net. A IN>
Aug 8 11:20:47 celje unbound: [6762:0] debug: timeout udp
Aug 8 11:20:47 celje unbound: [6762:0] debug: svcd callbacks start
Aug 8 11:20:47 celje unbound: [6762:0] debug: worker svcd callback for qstate 0x94caff0
Aug 8 11:20:47 celje unbound: [6762:0] debug: mesh_run: start
Aug 8 11:20:47 celje unbound: [6762:0] debug: iterator[module 1] operate: extstate:module_wait_reply event:module_event_noreply
Aug 8 11:20:47 celje unbound: [6762:0] info: iterator operate: query <i.root-servers.net. A IN>
Aug 8 11:20:47 celje unbound: [6762:0] debug: process_response: new external response event
Aug 8 11:20:47 celje unbound: [6762:0] debug: iter_handle processing q with state QUERY RESPONSE STATE
Aug 8 11:20:47 celje unbound: [6762:0] debug: query response was timeout
Aug 8 11:20:47 celje unbound: [6762:0] debug: iter_handle processing q with state QUERY TARGETS STATE
Aug 8 11:20:47 celje unbound: [6762:0] info: processQueryTargets: <i.root-servers.net. A IN>
Aug 8 11:20:47 celje unbound: [6762:0] debug: processQueryTargets: targetqueries 0, currentqueries 0
Aug 8 11:20:47 celje unbound: [6762:0] info: DelegationPoint<.>: 13 names (0 missing), 22 addrs (22 result, 0 avail) cacheNS
Aug 8 11:20:47 celje unbound: [6762:0] info: l.root-servers.net. * A AAAA
Aug 8 11:20:47 celje unbound: [6762:0] info: a.root-servers.net. * A AAAA
Aug 8 11:20:47 celje unbound: [6762:0] info: m.root-servers.net. * A AAAA
Aug 8 11:20:47 celje unbound: [6762:0] info: g.root-servers.net. * A
Aug 8 11:20:47 celje unbound: [6762:0] info: k.root-servers.net. * A AAAA
Aug 8 11:20:47 celje unbound: [6762:0] info: b.root-servers.net. * A
Aug 8 11:20:47 celje unbound: [6762:0] info: c.root-servers.net. * A
Aug 8 11:20:47 celje unbound: [6762:0] info: e.root-servers.net. * A
Aug 8 11:20:47 celje unbound: [6762:0] info: d.root-servers.net. * A AAAA
Aug 8 11:20:47 celje unbound: [6762:0] info: f.root-servers.net. * A AAAA
Aug 8 11:20:47 celje unbound: [6762:0] info: h.root-servers.net. * A AAAA
Aug 8 11:20:47 celje unbound: [6762:0] info: j.root-servers.net. * A AAAA
Aug 8 11:20:47 celje unbound: [6762:0] info: i.root-servers.net. * A AAAA
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip6 2001:7fe::53 port 53 (len 28)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip4 192.36.148.17 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip6 2001:503:c27::2:30 port 53 (len 28)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip4 192.58.128.30 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip6 2001:500:1::803f:235 port 53 (len 28)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip4 128.63.2.53 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip6 2001:500:2f::f port 53 (len 28)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip4 192.5.5.241 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip6 2001:500:2d::d port 53 (len 28)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip4 128.8.10.90 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip4 192.203.230.10 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip4 192.33.4.12 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip4 192.228.79.201 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip6 2001:7fd::1 port 53 (len 28)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip4 193.0.14.129 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip4 192.112.36.4 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip6 2001:dc3::35 port 53 (len 28)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip4 202.12.27.33 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip6 2001:503:ba3e::2:30 port 53 (len 28)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip4 198.41.0.4 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip6 2001:500:3::42 port 53 (len 28)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip4 199.7.83.42 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: attempt to get extra 1 targets
Aug 8 11:20:47 celje unbound: [6762:0] debug: servselect ip4 192.36.148.17 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: rtt=13248
Aug 8 11:20:47 celje unbound: [6762:0] debug: servselect ip4 192.228.79.201 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: rtt=12032
Aug 8 11:20:47 celje unbound: [6762:0] debug: servselect ip4 199.7.83.42 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: rtt=12032
Aug 8 11:20:47 celje unbound: [6762:0] debug: servselect ip4 198.41.0.4 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: rtt=12032
Aug 8 11:20:47 celje unbound: [6762:0] debug: servselect ip4 192.33.4.12 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: rtt=12032
Aug 8 11:20:47 celje unbound: [6762:0] debug: servselect ip4 128.8.10.90 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: rtt=12032
Aug 8 11:20:47 celje unbound: [6762:0] debug: servselect ip4 128.63.2.53 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: rtt=12032
Aug 8 11:20:47 celje unbound: [6762:0] debug: servselect ip4 193.0.14.129 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: rtt=12032
Aug 8 11:20:47 celje unbound: [6762:0] debug: servselect ip4 202.12.27.33 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: rtt=12032
Aug 8 11:20:47 celje unbound: [6762:0] debug: servselect ip4 192.58.128.30 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: rtt=12032
Aug 8 11:20:47 celje unbound: [6762:0] debug: servselect ip4 192.112.36.4 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: rtt=12032
Aug 8 11:20:47 celje unbound: [6762:0] debug: servselect ip4 192.203.230.10 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: rtt=12032
Aug 8 11:20:47 celje unbound: [6762:0] debug: servselect ip4 192.5.5.241 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: rtt=12032
Aug 8 11:20:47 celje unbound: [6762:0] debug: selrtt 12032
Aug 8 11:20:47 celje unbound: [6762:0] info: sending query: <i.root-servers.net. A IN>
Aug 8 11:20:47 celje unbound: [6762:0] debug: sending to target: <.> 192.112.36.4#53
Aug 8 11:20:47 celje unbound: [6762:0] debug: dnssec status: not expected
Aug 8 11:20:47 celje unbound: [6762:0] debug: EDNS lookup known=0 vs=0
Aug 8 11:20:47 celje unbound: [6762:0] debug: serviced query UDP timeout=12032 msec
Aug 8 11:20:47 celje unbound: [6762:0] debug: inserted new pending reply id=de1b
Aug 8 11:20:47 celje unbound: [6762:0] debug: opened UDP if=0 port=58958
Aug 8 11:20:47 celje unbound: [6762:0] debug: comm point start listening 19
Aug 8 11:20:47 celje unbound: [6762:0] debug: mesh_run: iterator module exit state is module_wait_reply
Aug 8 11:20:47 celje unbound: [6762:0] info: mesh_run: end 23 recursion states (1 with reply, 22 detached), 3 waiting replies, 0 recursion replies sent, 0 replies dropped, 0 states jostled out
Aug 8 11:20:47 celje unbound: [6762:0] info: 0RDd mod1 <a.root-servers.net. A IN>
Aug 8 11:20:47 celje unbound: [6762:0] info: 1RDd mod1 <b.root-servers.net. A IN>
Aug 8 11:20:47 celje unbound: [6762:0] info: 2RDd mod1 <c.root-servers.net. A IN>
Aug 8 11:20:47 celje unbound: [6762:0] info: 3RDd mod1 <d.root-servers.net. A IN>
Aug 8 11:20:47 celje unbound: [6762:0] info: 4RDd mod1 <e.root-servers.net. A IN>
Aug 8 11:20:47 celje unbound: [6762:0] info: 5RDd mod1 <f.root-servers.net. A IN>
Aug 8 11:20:47 celje unbound: [6762:0] info: 6RDd mod1 <g.root-servers.net. A IN>
Aug 8 11:20:47 celje unbound: [6762:0] info: 7RDd mod1 <h.root-servers.net. A IN>
Aug 8 11:20:47 celje unbound: [6762:0] info: 8RDd mod1 <i.root-servers.net. A IN>
Aug 8 11:20:47 celje unbound: [6762:0] info: 9RDd mod1 <j.root-servers.net. A IN>
Aug 8 11:20:47 celje unbound: [6762:0] info: 10RDd mod1 <k.root-servers.net. A IN>
Aug 8 11:20:47 celje unbound: [6762:0] info: 11RDd mod1 <l.root-servers.net. A IN>
Aug 8 11:20:47 celje unbound: [6762:0] info: 12RDd mod1 <m.root-servers.net. A IN>
Aug 8 11:20:47 celje unbound: [6762:0] info: 13RDd mod1 rep <. NS IN>
Aug 8 11:20:47 celje unbound: [6762:0] info: 14RDd mod1 <a.root-servers.net. AAAA IN>
Aug 8 11:20:47 celje unbound: [6762:0] info: 15RDd mod1 <d.root-servers.net. AAAA IN>
Aug 8 11:20:47 celje unbound: [6762:0] info: 16RDd mod1 <f.root-servers.net. AAAA IN>
Aug 8 11:20:47 celje unbound: [6762:0] info: 17RDd mod1 <h.root-servers.net. AAAA IN>
Aug 8 11:20:47 celje unbound: [6762:0] info: 18RDd mod1 <i.root-servers.net. AAAA IN>
Aug 8 11:20:47 celje unbound: [6762:0] info: 19RDd mod1 <j.root-servers.net. AAAA IN>
Aug 8 11:20:47 celje unbound: [6762:0] info: 20RDd mod1 <k.root-servers.net. AAAA IN>
Aug 8 11:20:47 celje unbound: [6762:0] info: 21RDd mod1 <l.root-servers.net. AAAA IN>
Aug 8 11:20:47 celje unbound: [6762:0] info: 22RDd mod1 <m.root-servers.net. AAAA IN>
Aug 8 11:20:47 celje unbound: [6762:0] debug: cache memory msg=33517 rrset=37164 infra=4176 val=41428
Aug 8 11:20:47 celje unbound: [6762:0] debug: svcd callbacks end
Aug 8 11:20:47 celje unbound: [6762:0] debug: close of port 30414
Aug 8 11:20:47 celje unbound: [6762:0] debug: close fd 26
Aug 8 11:20:47 celje unbound: [6762:0] debug: timeout udp
Aug 8 11:20:47 celje unbound: [6762:0] debug: svcd callbacks start
Aug 8 11:20:47 celje unbound: [6762:0] debug: worker svcd callback for qstate 0x9503060
Aug 8 11:20:47 celje unbound: [6762:0] debug: mesh_run: start
Aug 8 11:20:47 celje unbound: [6762:0] debug: iterator[module 1] operate: extstate:module_wait_reply event:module_event_noreply
Aug 8 11:20:47 celje unbound: [6762:0] info: iterator operate: query <. NS IN>
Aug 8 11:20:47 celje unbound: [6762:0] debug: process_response: new external response event
Aug 8 11:20:47 celje unbound: [6762:0] debug: iter_handle processing q with state QUERY RESPONSE STATE
Aug 8 11:20:47 celje unbound: [6762:0] debug: query response was timeout
Aug 8 11:20:47 celje unbound: [6762:0] debug: iter_handle processing q with state QUERY TARGETS STATE
Aug 8 11:20:47 celje unbound: [6762:0] info: processQueryTargets: <. NS IN>
Aug 8 11:20:47 celje unbound: [6762:0] debug: processQueryTargets: targetqueries 0, currentqueries 0
Aug 8 11:20:47 celje unbound: [6762:0] info: DelegationPoint<.>: 13 names (0 missing), 22 addrs (22 result, 0 avail) parentNS
Aug 8 11:20:47 celje unbound: [6762:0] info: l.root-servers.net. * A AAAA
Aug 8 11:20:47 celje unbound: [6762:0] info: a.root-servers.net. * A AAAA
Aug 8 11:20:47 celje unbound: [6762:0] info: m.root-servers.net. * A AAAA
Aug 8 11:20:47 celje unbound: [6762:0] info: g.root-servers.net. * A
Aug 8 11:20:47 celje unbound: [6762:0] info: k.root-servers.net. * A AAAA
Aug 8 11:20:47 celje unbound: [6762:0] info: b.root-servers.net. * A
Aug 8 11:20:47 celje unbound: [6762:0] info: c.root-servers.net. * A
Aug 8 11:20:47 celje unbound: [6762:0] info: e.root-servers.net. * A
Aug 8 11:20:47 celje unbound: [6762:0] info: d.root-servers.net. * A AAAA
Aug 8 11:20:47 celje unbound: [6762:0] info: f.root-servers.net. * A AAAA
Aug 8 11:20:47 celje unbound: [6762:0] info: h.root-servers.net. * A AAAA
Aug 8 11:20:47 celje unbound: [6762:0] info: j.root-servers.net. * A AAAA
Aug 8 11:20:47 celje unbound: [6762:0] info: i.root-servers.net. * A AAAA
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip6 2001:dc3::35 port 53 (len 28)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip4 202.12.27.33 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip6 2001:500:3::42 port 53 (len 28)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip4 199.7.83.42 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip6 2001:7fd::1 port 53 (len 28)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip4 193.0.14.129 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip6 2001:503:c27::2:30 port 53 (len 28)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip4 192.58.128.30 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip6 2001:7fe::53 port 53 (len 28)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip4 192.36.148.17 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip6 2001:500:1::803f:235 port 53 (len 28)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip4 128.63.2.53 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip4 192.112.36.4 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip6 2001:500:2f::f port 53 (len 28)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip4 192.5.5.241 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip4 192.203.230.10 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip6 2001:500:2d::d port 53 (len 28)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip4 128.8.10.90 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip4 192.33.4.12 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip4 192.228.79.201 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip6 2001:503:ba3e::2:30 port 53 (len 28)
Aug 8 11:20:47 celje unbound: [6762:0] debug: ip4 198.41.0.4 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: attempt to get extra 3 targets
Aug 8 11:20:47 celje unbound: [6762:0] debug: servselect ip4 192.36.148.17 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: rtt=13248
Aug 8 11:20:47 celje unbound: [6762:0] debug: servselect ip4 192.228.79.201 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: rtt=12032
Aug 8 11:20:47 celje unbound: [6762:0] debug: servselect ip4 199.7.83.42 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: rtt=12032
Aug 8 11:20:47 celje unbound: [6762:0] debug: servselect ip4 192.33.4.12 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: rtt=12032
Aug 8 11:20:47 celje unbound: [6762:0] debug: servselect ip4 198.41.0.4 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: rtt=12032
Aug 8 11:20:47 celje unbound: [6762:0] debug: servselect ip4 128.8.10.90 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: rtt=12032
Aug 8 11:20:47 celje unbound: [6762:0] debug: servselect ip4 193.0.14.129 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: rtt=12032
Aug 8 11:20:47 celje unbound: [6762:0] debug: servselect ip4 128.63.2.53 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: rtt=12032
Aug 8 11:20:47 celje unbound: [6762:0] debug: servselect ip4 192.58.128.30 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: rtt=12032
Aug 8 11:20:47 celje unbound: [6762:0] debug: servselect ip4 202.12.27.33 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: rtt=12032
Aug 8 11:20:47 celje unbound: [6762:0] debug: servselect ip4 192.112.36.4 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: rtt=120000
Aug 8 11:20:47 celje unbound: [6762:0] debug: servselect ip4 192.5.5.241 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: rtt=12032
Aug 8 11:20:47 celje unbound: [6762:0] debug: servselect ip4 192.203.230.10 port 53 (len 16)
Aug 8 11:20:47 celje unbound: [6762:0] debug: rtt=12032
Aug 8 11:20:47 celje unbound: [6762:0] debug: selrtt 12032
Aug 8 11:20:47 celje unbound: [6762:0] info: sending query: <. NS IN>
Aug 8 11:20:47 celje unbound: [6762:0] debug: sending to target: <.> 199.7.83.42#53
Aug 8 11:20:47 celje unbound: [6762:0] debug: dnssec status: not expected
Aug 8 11:20:47 celje unbound: [6762:0] debug: EDNS lookup known=0 vs=0
Aug 8 11:20:47 celje unbound: [6762:0] debug: serviced query UDP timeout=12032 msec
Aug 8 11:20:47 celje unbound: [6762:0] debug: inserted new pending reply id=8a18
Aug 8 11:20:47 celje unbound: [6762:0] debug: opened UDP if=0 port=37226
Aug 8 11:20:47 celje unbound: [6762:0] debug: comm point start listening 26
Aug 8 11:20:47 celje unbound: [6762:0] debug: mesh_run: iterator module exit state is module_wait_reply
Aug 8 11:20:47 celje unbound: [6762:0] info: mesh_run: end 23 recursion states (1 with reply, 22 detached), 3 waiting replies, 0 recursion replies sent, 0 replies dropped, 0 states jostled out
Aug 8 11:20:47 celje unbound: [6762:0] info: 0RDd mod1 <a.root-servers.net. A IN>
Aug 8 11:20:59 celje unbound: [6762:0] debug: timeout udp
Aug 8 11:20:59 celje unbound: [6762:0] debug: svcd callbacks start
Aug 8 11:20:59 celje unbound: [6762:0] debug: worker svcd callback for qstate 0x94caff0
Aug 8 11:20:59 celje unbound: [6762:0] debug: mesh_run: start
Aug 8 11:20:59 celje unbound: [6762:0] debug: iterator[module 1] operate: extstate:module_wait_reply event:module_event_noreply
Aug 8 11:20:59 celje unbound: [6762:0] info: iterator operate: query <i.root-servers.net. A IN>
Aug 8 11:20:59 celje unbound: [6762:0] debug: process_response: new external response event
Aug 8 11:20:59 celje unbound: [6762:0] debug: iter_handle processing q with state QUERY RESPONSE STATE
Aug 8 11:20:59 celje unbound: [6762:0] debug: query response was timeout
Aug 8 11:20:59 celje unbound: [6762:0] debug: iter_handle processing q with state QUERY TARGETS STATE
Aug 8 11:20:59 celje unbound: [6762:0] info: processQueryTargets: <i.root-servers.net. A IN>
Aug 8 11:20:59 celje unbound: [6762:0] debug: processQueryTargets: targetqueries 0, currentqueries 0
Aug 8 11:20:59 celje unbound: [6762:0] info: DelegationPoint<.>: 13 names (0 missing), 22 addrs (22 result, 0 avail) cacheNS
Aug 8 11:20:59 celje unbound: [6762:0] info: l.root-servers.net. * A AAAA
Aug 8 11:20:59 celje unbound: [6762:0] info: a.root-servers.net. * A AAAA
Aug 8 11:20:59 celje unbound: [6762:0] info: m.root-servers.net. * A AAAA
Aug 8 11:20:59 celje unbound: [6762:0] info: g.root-servers.net. * A
Aug 8 11:20:59 celje unbound: [6762:0] info: k.root-servers.net. * A AAAA
Aug 8 11:20:59 celje unbound: [6762:0] info: b.root-servers.net. * A
Aug 8 11:20:59 celje unbound: [6762:0] info: c.root-servers.net. * A
Aug 8 11:20:59 celje unbound: [6762:0] info: e.root-servers.net. * A
Aug 8 11:20:59 celje unbound: [6762:0] info: d.root-servers.net. * A AAAA
Aug 8 11:20:59 celje unbound: [6762:0] info: f.root-servers.net. * A AAAA
Aug 8 11:20:59 celje unbound: [6762:0] info: h.root-servers.net. * A AAAA
Aug 8 11:20:59 celje unbound: [6762:0] info: j.root-servers.net. * A AAAA
Aug 8 11:20:59 celje unbound: [6762:0] info: i.root-servers.net. * A AAAA
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip6 2001:7fe::53 port 53 (len 28)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip4 192.36.148.17 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip6 2001:503:c27::2:30 port 53 (len 28)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip4 192.58.128.30 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip6 2001:500:1::803f:235 port 53 (len 28)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip4 128.63.2.53 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip6 2001:500:2f::f port 53 (len 28)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip4 192.5.5.241 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip6 2001:500:2d::d port 53 (len 28)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip4 128.8.10.90 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip4 192.203.230.10 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip4 192.33.4.12 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip4 192.228.79.201 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip6 2001:7fd::1 port 53 (len 28)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip4 193.0.14.129 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip4 192.112.36.4 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip6 2001:dc3::35 port 53 (len 28)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip4 202.12.27.33 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip6 2001:503:ba3e::2:30 port 53 (len 28)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip4 198.41.0.4 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip6 2001:500:3::42 port 53 (len 28)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip4 199.7.83.42 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: attempt to get extra 1 targets
Aug 8 11:20:59 celje unbound: [6762:0] debug: servselect ip4 192.5.5.241 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: rtt=120000
Aug 8 11:20:59 celje unbound: [6762:0] debug: servselect ip4 192.203.230.10 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: rtt=120000
Aug 8 11:20:59 celje unbound: [6762:0] debug: servselect ip4 192.112.36.4 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: rtt=120000
Aug 8 11:20:59 celje unbound: [6762:0] debug: servselect ip4 192.58.128.30 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: rtt=120000
Aug 8 11:20:59 celje unbound: [6762:0] debug: servselect ip4 202.12.27.33 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: rtt=120000
Aug 8 11:20:59 celje unbound: [6762:0] debug: servselect ip4 193.0.14.129 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: rtt=120000
Aug 8 11:20:59 celje unbound: [6762:0] debug: servselect ip4 128.63.2.53 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: rtt=120000
Aug 8 11:20:59 celje unbound: [6762:0] debug: servselect ip4 128.8.10.90 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: rtt=120000
Aug 8 11:20:59 celje unbound: [6762:0] debug: servselect ip4 192.33.4.12 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: rtt=120000
Aug 8 11:20:59 celje unbound: [6762:0] debug: servselect ip4 198.41.0.4 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: rtt=120000
Aug 8 11:20:59 celje unbound: [6762:0] debug: servselect ip4 199.7.83.42 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: rtt=120000
Aug 8 11:20:59 celje unbound: [6762:0] debug: servselect ip4 192.228.79.201 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: rtt=120000
Aug 8 11:20:59 celje unbound: [6762:0] debug: servselect ip4 192.36.148.17 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: rtt=120000
Aug 8 11:20:59 celje unbound: [6762:0] debug: selrtt 120000
Aug 8 11:20:59 celje unbound: [6762:0] debug: chase to blacklisted lame server
Aug 8 11:20:59 celje unbound: [6762:0] debug: No more query targets, attempting last resort
Aug 8 11:20:59 celje unbound: [6762:0] debug: try to grab parent NS
Aug 8 11:20:59 celje unbound: [6762:0] debug: iter_handle processing q with state INIT REQUEST STATE
Aug 8 11:20:59 celje unbound: [6762:0] info: resolving <i.root-servers.net. A IN>
Aug 8 11:20:59 celje unbound: [6762:0] debug: request has dependency depth of 2
Aug 8 11:20:59 celje unbound: [6762:0] info: priming . IN NS
Aug 8 11:20:59 celje unbound: [6762:0] debug: mesh_run: iterator module exit state is module_wait_subquery
Aug 8 11:20:59 celje unbound: [6762:0] debug: iterator[module 1] operate: extstate:module_state_initial event:module_event_pass
Aug 8 11:20:59 celje unbound: [6762:0] info: iterator operate: query <. NS IN>
Aug 8 11:20:59 celje unbound: [6762:0] debug: iter_handle processing q with state QUERY TARGETS STATE
Aug 8 11:20:59 celje unbound: [6762:0] info: processQueryTargets: <. NS IN>
Aug 8 11:20:59 celje unbound: [6762:0] debug: processQueryTargets: targetqueries 0, currentqueries 0
Aug 8 11:20:59 celje unbound: [6762:0] info: DelegationPoint<.>: 13 names (0 missing), 22 addrs (0 result, 22 avail) parentNS
Aug 8 11:20:59 celje unbound: [6762:0] info: A.ROOT-SERVERS.NET. * A AAAA
Aug 8 11:20:59 celje unbound: [6762:0] info: B.ROOT-SERVERS.NET. * A
Aug 8 11:20:59 celje unbound: [6762:0] info: C.ROOT-SERVERS.NET. * A
Aug 8 11:20:59 celje unbound: [6762:0] info: D.ROOT-SERVERS.NET. * A AAAA
Aug 8 11:20:59 celje unbound: [6762:0] info: E.ROOT-SERVERS.NET. * A
Aug 8 11:20:59 celje unbound: [6762:0] info: F.ROOT-SERVERS.NET. * A AAAA
Aug 8 11:20:59 celje unbound: [6762:0] info: G.ROOT-SERVERS.NET. * A
Aug 8 11:20:59 celje unbound: [6762:0] info: H.ROOT-SERVERS.NET. * A AAAA
Aug 8 11:20:59 celje unbound: [6762:0] info: I.ROOT-SERVERS.NET. * A AAAA
Aug 8 11:20:59 celje unbound: [6762:0] info: J.ROOT-SERVERS.NET. * A AAAA
Aug 8 11:20:59 celje unbound: [6762:0] info: K.ROOT-SERVERS.NET. * A AAAA
Aug 8 11:20:59 celje unbound: [6762:0] info: L.ROOT-SERVERS.NET. * A AAAA
Aug 8 11:20:59 celje unbound: [6762:0] info: M.ROOT-SERVERS.NET. * A AAAA
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip4 198.41.0.4 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip6 2001:503:ba3e::2:30 port 53 (len 28)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip4 192.228.79.201 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip4 192.33.4.12 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip4 128.8.10.90 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip6 2001:500:2d::d port 53 (len 28)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip4 192.203.230.10 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip4 192.5.5.241 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip6 2001:500:2f::f port 53 (len 28)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip4 192.112.36.4 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip4 128.63.2.53 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip6 2001:500:1::803f:235 port 53 (len 28)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip4 192.36.148.17 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip6 2001:7fe::53 port 53 (len 28)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip4 192.58.128.30 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip6 2001:503:c27::2:30 port 53 (len 28)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip4 193.0.14.129 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip6 2001:7fd::1 port 53 (len 28)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip4 199.7.83.42 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip6 2001:500:3::42 port 53 (len 28)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip4 202.12.27.33 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: ip6 2001:dc3::35 port 53 (len 28)
Aug 8 11:20:59 celje unbound: [6762:0] debug: servselect ip4 202.12.27.33 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: rtt=120000
Aug 8 11:20:59 celje unbound: [6762:0] debug: servselect ip4 199.7.83.42 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: rtt=120000
Aug 8 11:20:59 celje unbound: [6762:0] debug: servselect ip4 193.0.14.129 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: rtt=120000
Aug 8 11:20:59 celje unbound: [6762:0] debug: servselect ip4 192.58.128.30 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: rtt=120000
Aug 8 11:20:59 celje unbound: [6762:0] debug: servselect ip4 192.36.148.17 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: rtt=120000
Aug 8 11:20:59 celje unbound: [6762:0] debug: servselect ip4 128.63.2.53 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: rtt=120000
Aug 8 11:20:59 celje unbound: [6762:0] debug: servselect ip4 192.112.36.4 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: rtt=120000
Aug 8 11:20:59 celje unbound: [6762:0] debug: servselect ip4 192.5.5.241 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: rtt=120000
Aug 8 11:20:59 celje unbound: [6762:0] debug: servselect ip4 192.203.230.10 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: rtt=120000
Aug 8 11:20:59 celje unbound: [6762:0] debug: servselect ip4 128.8.10.90 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: rtt=120000
Aug 8 11:20:59 celje unbound: [6762:0] debug: servselect ip4 192.33.4.12 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: rtt=120000
Aug 8 11:20:59 celje unbound: [6762:0] debug: servselect ip4 192.228.79.201 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: rtt=120000
Aug 8 11:20:59 celje unbound: [6762:0] debug: servselect ip4 198.41.0.4 port 53 (len 16)
Aug 8 11:20:59 celje unbound: [6762:0] debug: rtt=120000
Aug 8 11:20:59 celje unbound: [6762:0] debug: selrtt 120000
Aug 8 11:20:59 celje unbound: [6762:0] debug: chase to blacklisted lame server
Aug 8 11:20:59 celje unbound: [6762:0] debug: No more query targets, attempting last resort
Aug 8 11:20:59 celje unbound: [6762:0] info: found in cache <A.ROOT-SERVERS.NET. A IN>
Aug 8 11:20:59 celje unbound: [6762:0] info: found in cache <A.ROOT-SERVERS.NET. AAAA IN>
Aug 8 11:20:59 celje unbound: [6762:0] info: found in cache <B.ROOT-SERVERS.NET. A IN>
Aug 8 11:20:59 celje unbound: [6762:0] info: found in cache <C.ROOT-SERVERS.NET. A IN>
Aug 8 11:20:59 celje unbound: [6762:0] info: found in cache <D.ROOT-SERVERS.NET. A IN>
Aug 8 11:20:59 celje unbound: [6762:0] info: found in cache <D.ROOT-SERVERS.NET. AAAA IN>
Aug 8 11:20:59 celje unbound: [6762:0] info: found in cache <E.ROOT-SERVERS.NET. A IN>
Aug 8 11:20:59 celje unbound: [6762:0] info: found in cache <F.ROOT-SERVERS.NET. A IN>
Aug 8 11:20:59 celje unbound: [6762:0] info: found in cache <F.ROOT-SERVERS.NET. AAAA IN>
Aug 8 11:20:59 celje unbound: [6762:0] info: found in cache <G.ROOT-SERVERS.NET. A IN>
Aug 8 11:20:59 celje unbound: [6762:0] info: found in cache <H.ROOT-SERVERS.NET. A IN>
Aug 8 11:20:59 celje unbound: [6762:0] info: found in cache <H.ROOT-SERVERS.NET. AAAA IN>
Aug 8 11:20:59 celje unbound: [6762:0] info: found in cache <I.ROOT-SERVERS.NET. A IN>
Aug 8 11:20:59 celje unbound: [6762:0] info: found in cache <I.ROOT-SERVERS.NET. AAAA IN>
Aug 8 11:20:59 celje unbound: [6762:0] info: found in cache <J.ROOT-SERVERS.NET. A IN>
Aug 8 11:20:59 celje unbound: [6762:0] info: found in cache <J.ROOT-SERVERS.NET. AAAA IN>
Aug 8 11:20:59 celje unbound: [6762:0] info: found in cache <K.ROOT-SERVERS.NET. A IN>
Aug 8 11:20:59 celje unbound: [6762:0] info: found in cache <K.ROOT-SERVERS.NET. AAAA IN>
Aug 8 11:20:59 celje unbound: [6762:0] info: found in cache <L.ROOT-SERVERS.NET. A IN>
Aug 8 11:20:59 celje unbound: [6762:0] info: found in cache <L.ROOT-SERVERS.NET. AAAA IN>
Aug 8 11:20:59 celje unbound: [6762:0] info: found in cache <M.ROOT-SERVERS.NET. A IN>
Aug 8 11:20:59 celje unbound: [6762:0] info: found in cache <M.ROOT-SERVERS.NET. AAAA IN>
Aug 8 11:20:59 celje unbound: [6762:0] info: new pside target <A.ROOT-SERVERS.NET. A IN>
Aug 8 11:20:59 celje unbound: [6762:0] debug: try parent-side glue lookup
Aug 8 11:20:59 celje unbound: [6762:0] debug: mesh_run: iterator module exit state is module_wait_subquery
Aug 8 11:20:59 celje unbound: [6762:0] debug: iterator[module 1] operate: extstate:module_state_initial event:module_event_pass
Aug 8 11:20:59 celje unbound: [6762:0] info: iterator operate: query <A.ROOT-SERVERS.NET. A IN>
Aug 8 11:20:59 celje unbound: [6762:0] debug: iter_handle processing q with state INIT REQUEST STATE
Aug 8 11:20:59 celje unbound: [6762:0] info: resolving <A.ROOT-SERVERS.NET. A IN>
Aug 8 11:20:59 celje unbound: [6762:0] debug: request has dependency depth of 4
Aug 8 11:20:59 celje unbound: [6762:0] debug: cache blacklisted, going to the network
Aug 8 11:20:59 celje unbound: [6762:0] info: priming . IN NS
Aug 8 11:20:59 celje unbound: [6762:0] debug: attach failed, cycle detected
Aug 8 11:20:59 celje unbound: [6762:0] debug: could not prime root
Aug 8 11:20:59 celje unbound: [6762:0] debug: return error response REFUSED
Aug 8 11:20:59 celje unbound: [6762:0] debug: mesh_run: iterator module exit state is module_finished
Aug 8 11:20:59 celje unbound: [6762:0] debug: validator[module 0] operate: extstate:module_state_initial event:module_event_moddone
Aug 8 11:20:59 celje unbound: [6762:0] info: validator operate: query <A.ROOT-SERVERS.NET. A IN>
Aug 8 11:20:59 celje unbound: [6762:0] debug: validator: nextmodule returned
Aug 8 11:20:59 celje unbound: [6762:0] debug: not validating response due to CD bit
Aug 8 11:20:59 celje unbound: [6762:0] debug: mesh_run: validator module exit state is module_finished
Aug 8 11:20:59 celje unbound: [6762:0] info: found in cache <A.ROOT-SERVERS.NET. A IN>
Aug 8 11:20:59 celje unbound: [6762:0] info: found in cache <A.ROOT-SERVERS.NET. AAAA IN>
Aug 8 11:20:59 celje unbound: [6762:0] info: found in cache <B.ROOT-SERVERS.NET. A IN>
Aug 8 11:20:59 celje unbound: [6762:0] info: found in cache <C.ROOT-SERVERS.NET. A IN>
Aug 8 11:20:59 celje unbound: [6762:0] info: found in cache <D.ROOT-SERVERS.NET. A IN>
Aug 8 11:21:25 celje unbound: [6762:0] debug: timeout udp
Aug 8 11:21:25 celje unbound: [6762:0] debug: svcd callbacks start
Aug 8 11:21:25 celje unbound: [6762:0] debug: worker svcd callback for qstate 0x94d3000
Aug 8 11:21:25 celje unbound: [6762:0] debug: mesh_run: start
Aug 8 11:21:25 celje unbound: [6762:0] debug: iterator[module 1] operate: extstate:module_wait_reply event:module_event_noreply
Aug 8 11:21:25 celje unbound: [6762:0] info: iterator operate: query <h.root-servers.net. A IN>
Aug 8 11:21:25 celje unbound: [6762:0] debug: process_response: new external response event
Aug 8 11:21:25 celje unbound: [6762:0] debug: iter_handle processing q with state QUERY RESPONSE STATE
Aug 8 11:21:25 celje unbound: [6762:0] debug: query response was timeout
Aug 8 11:21:25 celje unbound: [6762:0] debug: iter_handle processing q with state QUERY TARGETS STATE
Aug 8 11:21:25 celje unbound: [6762:0] info: processQueryTargets: <h.root-servers.net. A IN>
Aug 8 11:21:25 celje unbound: [6762:0] debug: processQueryTargets: targetqueries 0, currentqueries 0
Aug 8 11:21:25 celje unbound: [6762:0] info: DelegationPoint<.>: 13 names (0 missing), 22 addrs (22 result, 0 avail) cacheNS
Aug 8 11:21:25 celje unbound: [6762:0] info: l.root-servers.net. * A AAAA
Aug 8 11:21:25 celje unbound: [6762:0] info: a.root-servers.net. * A AAAA
Aug 8 11:21:25 celje unbound: [6762:0] info: m.root-servers.net. * A AAAA
Aug 8 11:21:25 celje unbound: [6762:0] info: g.root-servers.net. * A
Aug 8 11:21:25 celje unbound: [6762:0] info: k.root-servers.net. * A AAAA
Aug 8 11:21:25 celje unbound: [6762:0] info: b.root-servers.net. * A
Aug 8 11:21:25 celje unbound: [6762:0] info: c.root-servers.net. * A
Aug 8 11:21:25 celje unbound: [6762:0] info: e.root-servers.net. * A
Aug 8 11:21:25 celje unbound: [6762:0] info: d.root-servers.net. * A AAAA
Aug 8 11:21:25 celje unbound: [6762:0] info: f.root-servers.net. * A AAAA
Aug 8 11:21:25 celje unbound: [6762:0] info: h.root-servers.net. * A AAAA
Aug 8 11:21:25 celje unbound: [6762:0] info: j.root-servers.net. * A AAAA
Aug 8 11:21:25 celje unbound: [6762:0] info: i.root-servers.net. * A AAAA
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip6 2001:7fe::53 port 53 (len 28)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip4 192.36.148.17 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip6 2001:503:c27::2:30 port 53 (len 28)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip4 192.58.128.30 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip6 2001:500:1::803f:235 port 53 (len 28)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip4 128.63.2.53 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip6 2001:500:2f::f port 53 (len 28)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip4 192.5.5.241 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip6 2001:500:2d::d port 53 (len 28)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip4 128.8.10.90 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip4 192.203.230.10 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip4 192.33.4.12 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip4 192.228.79.201 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip6 2001:7fd::1 port 53 (len 28)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip4 193.0.14.129 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip4 192.112.36.4 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip6 2001:dc3::35 port 53 (len 28)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip4 202.12.27.33 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip6 2001:503:ba3e::2:30 port 53 (len 28)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip4 198.41.0.4 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip6 2001:500:3::42 port 53 (len 28)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip4 199.7.83.42 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: attempt to get extra 1 targets
Aug 8 11:21:25 celje unbound: [6762:0] debug: servselect ip4 202.12.27.33 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: rtt=24064
Aug 8 11:21:25 celje unbound: [6762:0] debug: servselect ip4 128.63.2.53 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: rtt=120000
Aug 8 11:21:25 celje unbound: [6762:0] debug: servselect ip4 192.112.36.4 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: rtt=24064
Aug 8 11:21:25 celje unbound: [6762:0] debug: servselect ip4 199.7.83.42 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: rtt=24064
Aug 8 11:21:25 celje unbound: [6762:0] debug: servselect ip4 198.41.0.4 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: rtt=24064
Aug 8 11:21:25 celje unbound: [6762:0] debug: servselect ip4 192.203.230.10 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: rtt=24064
Aug 8 11:21:25 celje unbound: [6762:0] debug: servselect ip4 128.8.10.90 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: rtt=24064
Aug 8 11:21:25 celje unbound: [6762:0] debug: servselect ip4 192.228.79.201 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: rtt=24064
Aug 8 11:21:25 celje unbound: [6762:0] debug: servselect ip4 192.36.148.17 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: rtt=26496
Aug 8 11:21:25 celje unbound: [6762:0] debug: servselect ip4 192.33.4.12 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: rtt=24064
Aug 8 11:21:25 celje unbound: [6762:0] debug: servselect ip4 193.0.14.129 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: rtt=24064
Aug 8 11:21:25 celje unbound: [6762:0] debug: servselect ip4 192.5.5.241 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: rtt=24064
Aug 8 11:21:25 celje unbound: [6762:0] debug: servselect ip4 192.58.128.30 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: rtt=24064
Aug 8 11:21:25 celje unbound: [6762:0] debug: selrtt 24064
Aug 8 11:21:25 celje unbound: [6762:0] info: sending query: <h.root-servers.net. A IN>
Aug 8 11:21:25 celje unbound: [6762:0] debug: sending to target: <.> 192.5.5.241#53
Aug 8 11:21:25 celje unbound: [6762:0] debug: dnssec status: not expected
Aug 8 11:21:25 celje unbound: [6762:0] debug: EDNS lookup known=0 vs=0
Aug 8 11:21:25 celje unbound: [6762:0] debug: serviced query UDP timeout=24064 msec
Aug 8 11:21:25 celje unbound: [6762:0] debug: inserted new pending reply id=5438
Aug 8 11:21:25 celje unbound: [6762:0] debug: opened UDP if=0 port=41764
Aug 8 11:21:25 celje unbound: [6762:0] debug: comm point start listening 14
Aug 8 11:21:25 celje unbound: [6762:0] debug: mesh_run: iterator module exit state is module_wait_reply
Aug 8 11:21:25 celje unbound: [6762:0] info: mesh_run: end 1 recursion states (0 with reply, 1 detached), 0 waiting replies, 3 recursion replies sent, 0 replies dropped, 0 states jostled out
Aug 8 11:21:25 celje unbound: [6762:0] info: average recursion processing time 27.967763 sec
Aug 8 11:21:25 celje unbound: [6762:0] info: histogram of recursion processing times
Aug 8 11:21:25 celje unbound: [6762:0] info: [25%]=0 median[50%]=0 [75%]=0
Aug 8 11:21:25 celje unbound: [6762:0] info: lower(secs) upper(secs) recursions
Aug 8 11:21:25 celje unbound: [6762:0] info: 16.000000 32.000000 2
Aug 8 11:21:25 celje unbound: [6762:0] info: 32.000000 64.000000 1
Aug 8 11:21:25 celje unbound: [6762:0] info: 0RDd mod1 <h.root-servers.net. A IN>
Aug 8 11:21:25 celje unbound: [6762:0] debug: cache memory msg=33149 rrset=37164 infra=4176 val=41428
Aug 8 11:21:25 celje unbound: [6762:0] debug: svcd callbacks end
Aug 8 11:21:25 celje unbound: [6762:0] debug: close of port 11881
Aug 8 11:21:25 celje unbound: [6762:0] debug: close fd 13
Aug 8 11:21:25 celje unbound: [6762:0] debug: answer cb
Aug 8 11:21:25 celje unbound: [6762:0] debug: Incoming reply id = 5438
Aug 8 11:21:25 celje unbound: [6762:0] debug: Incoming reply addr = ip4 192.5.5.241 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: lookup size is 1 entries
Aug 8 11:21:25 celje unbound: [6762:0] debug: received udp reply.
Aug 8 11:21:25 celje unbound: [6762:0] debug: udp message[713:0] 5438841000010001000D001601680C726F6F742D73657276657273036E65740000010001C00C000100010036EE800004803F0235C00E000200010036EE8000040161C00EC00E000200010036EE8000040169C00EC00E000200010036EE800004016CC00EC00E000200010036EE800002C00CC00E000200010036EE800004016BC00EC00E000200010036EE800004016AC00EC00E000200010036EE8000040167C00EC00E000200010036EE8000040163C00EC00E000200010036EE8000040164C00EC00E000200010036EE8000040162C00EC00E000200010036EE8000040166C00EC00E000200010036EE8000040165C00EC00E000200010036EE800004016D
Aug 8 11:21:25 celje unbound: [6762:0] debug: udp message[713:256] C00EC040000100010036EE800004C6290004C0CE000100010036EE800004C0E44FC9C0AE000100010036EE800004C021040CC0BE000100010036EE80000480080A5AC0EE000100010036EE800004C0CBE60AC0DE000100010036EE800004C00505F1C09E000100010036EE800004C0702404C050000100010036EE800004C0249411C08E000100010036EE800004C03A801EC07E000100010036EE800004C1000E81C060000100010036EE800004C707532AC0FE000100010036EE800004CA0C1B21C040001C00010036EE80001020010503BA3E00000000000000020030C0BE001C00010036EE80001020010500002D0000000000000000000DC0DE001C0001
Aug 8 11:21:25 celje unbound: [6762:0] debug: udp message[713:512] 0036EE80001020010500002F0000000000000000000FC00C001C00010036EE800010200105000001000000000000803F0235C050001C00010036EE800010200107FE000000000000000000000053C08E001C00010036EE800010200105030C2700000000000000020030C07E001C00010036EE800010200107FD000000000000000000000001C060001C00010036EE80001020010500000300000000000000000042C0FE001C00010036EE80001020010DC30000000000000000000000350000291000000080000000
Aug 8 11:21:25 celje unbound: [6762:0] debug: outnet handle udp reply
Aug 8 11:21:25 celje unbound: [6762:0] debug: serviced query: EDNS works for ip4 192.5.5.241 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: measured roundtrip at 54 msec
Aug 8 11:21:25 celje unbound: [6762:0] debug: svcd callbacks start
Aug 8 11:21:25 celje unbound: [6762:0] debug: worker svcd callback for qstate 0x94d3000
Aug 8 11:21:25 celje unbound: [6762:0] debug: mesh_run: start
Aug 8 11:21:25 celje unbound: [6762:0] debug: iterator[module 1] operate: extstate:module_wait_reply event:module_event_reply
Aug 8 11:21:25 celje unbound: [6762:0] info: iterator operate: query <h.root-servers.net. A IN>
Aug 8 11:21:25 celje unbound: [6762:0] debug: process_response: new external response event
Aug 8 11:21:25 celje unbound: [6762:0] info: scrub for <. NS IN>
Aug 8 11:21:25 celje unbound: [6762:0] info: response for <h.root-servers.net. A IN>
Aug 8 11:21:25 celje unbound: [6762:0] info: reply from <.> 192.5.5.241#53
Aug 8 11:21:25 celje unbound: [6762:0] info: incoming scrubbed packet: ;; ->>HEADER<<- opcode: QUERY, rcode: NOERROR, id: 0#012;; flags: qr aa ; QUERY: 1, ANSWER: 1, AUTHORITY: 13, ADDITIONAL: 21 #012;; QUESTION SECTION:#012;; h.root-servers.net.#011IN#011A#012#012;; ANSWER SECTION:#012h.root-servers.net.#0113600000#011IN#011A#011128.63.2.53#012#012;; AUTHORITY SECTION:#012root-servers.net.#0113600000#011IN#011NS#011a.root-servers.net.#012root-servers.net.#0113600000#011IN#011NS#011i.root-servers.net.#012root-servers.net.#0113600000#011IN#011NS#011l.root-servers.net.#012root-servers.net.#0113600000#011IN#011NS#011h.root-servers.net.#012root-servers.net.#0113600000#011IN#011NS#011k.root-servers.net.#012root-servers.net.#0113600000#011IN#011NS#011j.root-servers.net.#012root-servers.net.#0113600000#011IN#011NS#011g.root-servers.net.#012root-servers.net.#0113600000#011IN#011NS#011c.root-servers.net.#012root-servers.net.#0113600000#011IN#011NS#011d.root-servers.net.#012root-servers.net.#0113600000#011IN#011NS#011b.root-servers.net.#012root-servers.net.#0113600000#011IN#011NS#011f.root-servers.net.#012root-servers.net.#0113600000#011IN#011NS#011e.root-servers.net.#012root-servers.net.#0113600000#011IN#011NS#011m.root-servers.net.#012#012;; ADDITIONAL SECTION:#012a.root-servers.net.#0113600000#011IN#011A#011198.41.0.4#012b.root-servers.net.#0113600000#011IN#011A#011192.228.79.201#012c.root-servers.net.#0113600000#011IN#011A#011192.33.4.12#012d.root-servers.net.#0113600000#011IN#011A#011128.8.10.90#012e.root-servers.net.#0113600000#011IN#011A#011192.203.230.10#012f.root-servers.net.#0113600000#011IN#011A#011192.5.5.241#012g.root-servers.net.#0113600000#011IN#011A#011192.112.36.4#012i.root-servers.net.#0113600000#011IN#011A#011192.36.148.17#012j.root-servers.net.#0113600000#011IN#011A#011192.58.128.30#012k.root-servers.net.#0113600000#011IN#011A#011193.0.14.129#012l.root-servers.net.#0113600000#011IN#011A#011199.7.83.42#012m.root-servers.net.#0113600000#011IN#011A#011202.12.27.33#012a.root-servers.net.#0113600000#011IN#011AAAA#0112001:503:ba3e::2:30#012d.root-servers.net.#0113600000#011IN#011AAAA#0112001:500:2d::d#012f.root-servers.net.#0113600000#011IN#011AAAA#0112001:500:2f::f#012h.root-servers.net.#0113600000#011IN#011AAAA#0112001:500:1::803f:235#012i.root-servers.net.#0113600000#011IN#011AAAA#0112001:7fe::53#012j.root-servers.net.#0113600000#011IN#011AAAA#0112001:503:c27::2:30#012k.root-servers.net.#0113600000#011IN#011AAAA#0112001:7fd::1#012l.root-servers.net.#0113600000#011IN#011AAAA#0112001:500:3::42#012m.root-servers.net.#0113600000#011IN#011AAAA#0112001:dc3::35#012#012;; Query time: 0 msec#012;; WHEN: Thu Jan 1 00:00:00 1970#012;; MSG SIZE rcvd: 702
Aug 8 11:21:25 celje unbound: [6762:0] debug: iter_handle processing q with state QUERY RESPONSE STATE
Aug 8 11:21:25 celje unbound: [6762:0] info: query response was ANSWER
Aug 8 11:21:25 celje unbound: [6762:0] debug: iter_handle processing q with state FINISHED RESPONSE STATE
Aug 8 11:21:25 celje unbound: [6762:0] info: finishing processing for <h.root-servers.net. A IN>
Aug 8 11:21:25 celje unbound: [6762:0] debug: mesh_run: iterator module exit state is module_finished
Aug 8 11:21:25 celje unbound: [6762:0] debug: validator[module 0] operate: extstate:module_state_initial event:module_event_moddone
Aug 8 11:21:25 celje unbound: [6762:0] info: validator operate: query <h.root-servers.net. A IN>
Aug 8 11:21:25 celje unbound: [6762:0] debug: validator: nextmodule returned
Aug 8 11:21:25 celje unbound: [6762:0] debug: val handle processing q with state VAL_INIT_STATE
Aug 8 11:21:25 celje unbound: [6762:0] debug: validator classification positive
Aug 8 11:21:25 celje unbound: [6762:0] info: no signer, using <h.root-servers.net. TYPE0 CLASS0>
Aug 8 11:21:25 celje unbound: [6762:0] debug: val handle processing q with state VAL_FINISHED_STATE
Aug 8 11:21:25 celje unbound: [6762:0] info: DLV init look <h.root-servers.net. DS IN>
Aug 8 11:21:25 celje unbound: [6762:0] info: DLV name <h.root-servers.net.dlv.isc.org. DLV IN>
Aug 8 11:21:25 celje unbound: [6762:0] info: negcache dlvlookup <h.root-servers.net.dlv.isc.org. DLV IN>
Aug 8 11:21:25 celje unbound: [6762:0] info: generate request <h.root-servers.net.dlv.isc.org. DLV IN>
Aug 8 11:21:25 celje unbound: [6762:0] debug: mesh_run: validator module exit state is module_wait_subquery
Aug 8 11:21:25 celje unbound: [6762:0] debug: validator[module 0] operate: extstate:module_state_initial event:module_event_pass
Aug 8 11:21:25 celje unbound: [6762:0] info: validator operate: query <h.root-servers.net.dlv.isc.org. DLV IN>
Aug 8 11:21:25 celje unbound: [6762:0] debug: validator: pass to next module
Aug 8 11:21:25 celje unbound: [6762:0] debug: mesh_run: validator module exit state is module_wait_module
Aug 8 11:21:25 celje unbound: [6762:0] debug: iterator[module 1] operate: extstate:module_state_initial event:module_event_pass
Aug 8 11:21:25 celje unbound: [6762:0] debug: process_request: new external request event
Aug 8 11:21:25 celje unbound: [6762:0] debug: iter_handle processing q with state INIT REQUEST STATE
Aug 8 11:21:25 celje unbound: [6762:0] info: resolving <h.root-servers.net.dlv.isc.org. DLV IN>
Aug 8 11:21:25 celje unbound: [6762:0] debug: request has dependency depth of 0
Aug 8 11:21:25 celje unbound: [6762:0] debug: cache delegation returns delegpt
Aug 8 11:21:25 celje unbound: [6762:0] info: DelegationPoint<.>: 13 names (4 missing), 22 addrs (0 result, 22 avail) cacheNS
Aug 8 11:21:25 celje unbound: [6762:0] info: l.root-servers.net. * A AAAA
Aug 8 11:21:25 celje unbound: [6762:0] info: a.root-servers.net. * A AAAA
Aug 8 11:21:25 celje unbound: [6762:0] info: m.root-servers.net. * A AAAA
Aug 8 11:21:25 celje unbound: [6762:0] info: g.root-servers.net. A
Aug 8 11:21:25 celje unbound: [6762:0] info: k.root-servers.net. * A AAAA
Aug 8 11:21:25 celje unbound: [6762:0] info: b.root-servers.net. A
Aug 8 11:21:25 celje unbound: [6762:0] info: c.root-servers.net. A
Aug 8 11:21:25 celje unbound: [6762:0] info: e.root-servers.net. A
Aug 8 11:21:25 celje unbound: [6762:0] info: d.root-servers.net. * A AAAA
Aug 8 11:21:25 celje unbound: [6762:0] info: f.root-servers.net. * A AAAA
Aug 8 11:21:25 celje unbound: [6762:0] info: h.root-servers.net. * A AAAA
Aug 8 11:21:25 celje unbound: [6762:0] info: j.root-servers.net. * A AAAA
Aug 8 11:21:25 celje unbound: [6762:0] info: i.root-servers.net. * A AAAA
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip6 2001:7fe::53 port 53 (len 28)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip4 192.36.148.17 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip6 2001:503:c27::2:30 port 53 (len 28)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip4 192.58.128.30 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip6 2001:500:1::803f:235 port 53 (len 28)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip4 128.63.2.53 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip6 2001:500:2f::f port 53 (len 28)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip4 192.5.5.241 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip6 2001:500:2d::d port 53 (len 28)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip4 128.8.10.90 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip4 192.203.230.10 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip4 192.33.4.12 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip4 192.228.79.201 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip6 2001:7fd::1 port 53 (len 28)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip4 193.0.14.129 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip4 192.112.36.4 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip6 2001:dc3::35 port 53 (len 28)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip4 202.12.27.33 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip6 2001:503:ba3e::2:30 port 53 (len 28)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip4 198.41.0.4 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip6 2001:500:3::42 port 53 (len 28)
Aug 8 11:21:25 celje unbound: [6762:0] debug: ip4 199.7.83.42 port 53 (len 16)
Aug 8 11:21:25 celje unbound: [6762:0] debug: iter_handle processing q with state INIT REQUEST STATE (stage 2)
Aug 8 11:21:25 celje unbound: [6762:0] info: resolving (init part 2): <h.root-servers.net.dlv.isc.org. DLV IN>
Aug 8 11:21:25 celje unbound: [6762:0] debug: iter_handle processing q with state INIT REQUEST STATE (stage 3)
Aug 8 11:21:25 celje unbound: [6762:0] info: resolving (init part 3): <h.root-servers.net.dlv.isc.org. DLV IN>
Aug 8 11:21:25 celje unbound: [6762:0] debug: iter_handle processing q with state QUERY TARGETS STATE
Aug 8 11:21:25 celje unbound: [6762:0] info: processQueryTargets: <h.root-servers.net.dlv.isc.org. DLV IN>
Aug 8 11:21:25 celje unbound: [6762:0] debug: processQueryTargets: targetqueries 0, currentqueries 0
Aug 8 11:21:25 celje unbound: [6762:0] info: DelegationPoint<.>: 13 names (0 missing), 22 addrs (0 result, 22 avail) cacheNS
Aug 8 11:21:25 celje unbound: [6762:0] info: l.root-servers.net. * A AAAA
Aug 8 11:21:25 celje unbound: [6762:0] info: a.root-servers.net. * A AAAA
Aug 8 11:21:25 celje unbound: [6762:0] info: m.root-servers.net. * A AAAA
Aug 8 11:21:25 celje unbound: [6762:0] info: g.root-servers.net. * A
Aug 8 11:21:25 celje unbound: [6762:0] info: k.root-servers.net. * A AAAA
Aug 8 11:21:25 celje unbound: [6762:0] info: b.root-servers.net. * A
Aug 8 11:21:25 celje unbound: [6762:0] info: c.root-servers.net. * A
Aug 8 11:21:25 celje unbound: [6762:0] info: e.root-servers.net. * A
Aug 8 11:21:25 celje unbound: [6762:0] info: d.root-servers.net. * A AAAA
Aug 8 11:21:25 celje unbound: [6762:0] info: f.root-servers.net. * A AAAA
Aug 8 11:21:25 celje unbound: [6762:0] info: h.root-servers.net. * A AAAA
Aug 8 11:22:25 celje unbound: [6762:0] debug: answer from the cache failed
Aug 8 11:22:25 celje unbound: [6762:0] debug: udp request from ip4 127.0.0.1 port 53967 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: mesh_run: start
Aug 8 11:22:25 celje unbound: [6762:0] debug: validator[module 0] operate: extstate:module_state_initial event:module_event_new
Aug 8 11:22:25 celje unbound: [6762:0] info: validator operate: query <. NS IN>
Aug 8 11:22:25 celje unbound: [6762:0] debug: validator: pass to next module
Aug 8 11:22:25 celje unbound: [6762:0] debug: mesh_run: validator module exit state is module_wait_module
Aug 8 11:22:25 celje unbound: [6762:0] debug: iterator[module 1] operate: extstate:module_state_initial event:module_event_pass
Aug 8 11:22:25 celje unbound: [6762:0] debug: process_request: new external request event
Aug 8 11:22:25 celje unbound: [6762:0] debug: iter_handle processing q with state INIT REQUEST STATE
Aug 8 11:22:25 celje unbound: [6762:0] info: resolving <. NS IN>
Aug 8 11:22:25 celje unbound: [6762:0] debug: request has dependency depth of 0
Aug 8 11:22:25 celje unbound: [6762:0] debug: cache delegation returns delegpt
Aug 8 11:22:25 celje unbound: [6762:0] info: DelegationPoint<.>: 13 names (4 missing), 22 addrs (0 result, 22 avail) cacheNS
Aug 8 11:22:25 celje unbound: [6762:0] info: l.root-servers.net. * A AAAA
Aug 8 11:22:25 celje unbound: [6762:0] info: a.root-servers.net. * A AAAA
Aug 8 11:22:25 celje unbound: [6762:0] info: m.root-servers.net. * A AAAA
Aug 8 11:22:25 celje unbound: [6762:0] info: g.root-servers.net. A
Aug 8 11:22:25 celje unbound: [6762:0] info: k.root-servers.net. * A AAAA
Aug 8 11:22:25 celje unbound: [6762:0] info: b.root-servers.net. A
Aug 8 11:22:25 celje unbound: [6762:0] info: c.root-servers.net. A
Aug 8 11:22:25 celje unbound: [6762:0] info: e.root-servers.net. A
Aug 8 11:22:25 celje unbound: [6762:0] info: d.root-servers.net. * A AAAA
Aug 8 11:22:25 celje unbound: [6762:0] info: f.root-servers.net. * A AAAA
Aug 8 11:22:25 celje unbound: [6762:0] info: h.root-servers.net. * A AAAA
Aug 8 11:22:25 celje unbound: [6762:0] info: j.root-servers.net. * A AAAA
Aug 8 11:22:25 celje unbound: [6762:0] info: i.root-servers.net. * A AAAA
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip6 2001:7fe::53 port 53 (len 28)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip4 192.36.148.17 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip6 2001:503:c27::2:30 port 53 (len 28)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip4 192.58.128.30 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip6 2001:500:1::803f:235 port 53 (len 28)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip4 128.63.2.53 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip6 2001:500:2f::f port 53 (len 28)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip4 192.5.5.241 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip6 2001:500:2d::d port 53 (len 28)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip4 128.8.10.90 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip4 192.203.230.10 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip4 192.33.4.12 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip4 192.228.79.201 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip6 2001:7fd::1 port 53 (len 28)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip4 193.0.14.129 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip4 192.112.36.4 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip6 2001:dc3::35 port 53 (len 28)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip4 202.12.27.33 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip6 2001:503:ba3e::2:30 port 53 (len 28)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip4 198.41.0.4 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip6 2001:500:3::42 port 53 (len 28)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip4 199.7.83.42 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: iter_handle processing q with state INIT REQUEST STATE (stage 2)
Aug 8 11:22:25 celje unbound: [6762:0] info: resolving (init part 2): <. NS IN>
Aug 8 11:22:25 celje unbound: [6762:0] debug: iter_handle processing q with state INIT REQUEST STATE (stage 3)
Aug 8 11:22:25 celje unbound: [6762:0] info: resolving (init part 3): <. NS IN>
Aug 8 11:22:25 celje unbound: [6762:0] debug: iter_handle processing q with state QUERY TARGETS STATE
Aug 8 11:22:25 celje unbound: [6762:0] info: processQueryTargets: <. NS IN>
Aug 8 11:22:25 celje unbound: [6762:0] debug: processQueryTargets: targetqueries 0, currentqueries 0
Aug 8 11:22:25 celje unbound: [6762:0] info: DelegationPoint<.>: 13 names (0 missing), 22 addrs (0 result, 22 avail) cacheNS
Aug 8 11:22:25 celje unbound: [6762:0] info: l.root-servers.net. * A AAAA
Aug 8 11:22:25 celje unbound: [6762:0] info: a.root-servers.net. * A AAAA
Aug 8 11:22:25 celje unbound: [6762:0] info: m.root-servers.net. * A AAAA
Aug 8 11:22:25 celje unbound: [6762:0] info: g.root-servers.net. * A
Aug 8 11:22:25 celje unbound: [6762:0] info: k.root-servers.net. * A AAAA
Aug 8 11:22:25 celje unbound: [6762:0] info: b.root-servers.net. * A
Aug 8 11:22:25 celje unbound: [6762:0] info: c.root-servers.net. * A
Aug 8 11:22:25 celje unbound: [6762:0] info: e.root-servers.net. * A
Aug 8 11:22:25 celje unbound: [6762:0] info: d.root-servers.net. * A AAAA
Aug 8 11:22:25 celje unbound: [6762:0] info: f.root-servers.net. * A AAAA
Aug 8 11:22:25 celje unbound: [6762:0] info: h.root-servers.net. * A AAAA
Aug 8 11:22:25 celje unbound: [6762:0] info: j.root-servers.net. * A AAAA
Aug 8 11:22:25 celje unbound: [6762:0] info: i.root-servers.net. * A AAAA
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip6 2001:7fe::53 port 53 (len 28)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip4 192.36.148.17 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip6 2001:503:c27::2:30 port 53 (len 28)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip4 192.58.128.30 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip6 2001:500:1::803f:235 port 53 (len 28)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip4 128.63.2.53 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip6 2001:500:2f::f port 53 (len 28)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip4 192.5.5.241 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip6 2001:500:2d::d port 53 (len 28)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip4 128.8.10.90 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip4 192.203.230.10 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip4 192.33.4.12 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip4 192.228.79.201 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip6 2001:7fd::1 port 53 (len 28)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip4 193.0.14.129 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip4 192.112.36.4 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip6 2001:dc3::35 port 53 (len 28)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip4 202.12.27.33 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip6 2001:503:ba3e::2:30 port 53 (len 28)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip4 198.41.0.4 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip6 2001:500:3::42 port 53 (len 28)
Aug 8 11:22:25 celje unbound: [6762:0] debug: ip4 199.7.83.42 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: attempt to get extra 3 targets
Aug 8 11:22:25 celje unbound: [6762:0] debug: servselect ip4 199.7.83.42 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: rtt=24064
Aug 8 11:22:25 celje unbound: [6762:0] debug: servselect ip4 198.41.0.4 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: rtt=24064
Aug 8 11:22:25 celje unbound: [6762:0] debug: servselect ip4 202.12.27.33 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: rtt=24064
Aug 8 11:22:25 celje unbound: [6762:0] debug: servselect ip4 192.112.36.4 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: rtt=24064
Aug 8 11:22:25 celje unbound: [6762:0] debug: servselect ip4 193.0.14.129 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: rtt=24064
Aug 8 11:22:25 celje unbound: [6762:0] debug: servselect ip4 192.228.79.201 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: rtt=24064
Aug 8 11:22:25 celje unbound: [6762:0] debug: servselect ip4 192.33.4.12 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: rtt=24064
Aug 8 11:22:25 celje unbound: [6762:0] debug: servselect ip4 192.203.230.10 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: rtt=24064
Aug 8 11:22:25 celje unbound: [6762:0] debug: servselect ip4 128.8.10.90 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: rtt=24064
Aug 8 11:22:25 celje unbound: [6762:0] debug: servselect ip4 192.5.5.241 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: rtt=211
Aug 8 11:22:25 celje unbound: [6762:0] debug: servselect ip4 128.63.2.53 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: rtt=48128
Aug 8 11:22:25 celje unbound: [6762:0] debug: servselect ip4 192.58.128.30 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: rtt=24064
Aug 8 11:22:25 celje unbound: [6762:0] debug: servselect ip4 192.36.148.17 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: rtt=26496
Aug 8 11:22:25 celje unbound: [6762:0] debug: selrtt 211
Aug 8 11:22:25 celje unbound: [6762:0] info: sending query: <. NS IN>
Aug 8 11:22:25 celje unbound: [6762:0] debug: sending to target: <.> 192.5.5.241#53
Aug 8 11:22:25 celje unbound: [6762:0] debug: dnssec status: not expected
Aug 8 11:22:25 celje unbound: [6762:0] debug: EDNS lookup known=1 vs=0
Aug 8 11:22:25 celje unbound: [6762:0] debug: serviced query UDP timeout=211 msec
Aug 8 11:22:25 celje unbound: [6762:0] debug: inserted new pending reply id=819b
Aug 8 11:22:25 celje unbound: [6762:0] debug: opened UDP if=0 port=36419
Aug 8 11:22:25 celje unbound: [6762:0] debug: comm point start listening 13
Aug 8 11:22:25 celje unbound: [6762:0] debug: mesh_run: iterator module exit state is module_wait_reply
Aug 8 11:22:25 celje unbound: [6762:0] info: mesh_run: end 1 recursion states (1 with reply, 0 detached), 1 waiting replies, 3 recursion replies sent, 0 replies dropped, 0 states jostled out
Aug 8 11:22:25 celje unbound: [6762:0] info: average recursion processing time 27.967763 sec
Aug 8 11:22:25 celje unbound: [6762:0] info: histogram of recursion processing times
Aug 8 11:22:25 celje unbound: [6762:0] info: [25%]=0 median[50%]=0 [75%]=0
Aug 8 11:22:25 celje unbound: [6762:0] info: lower(secs) upper(secs) recursions
Aug 8 11:22:25 celje unbound: [6762:0] info: 16.000000 32.000000 2
Aug 8 11:22:25 celje unbound: [6762:0] info: 32.000000 64.000000 1
Aug 8 11:22:25 celje unbound: [6762:0] info: 0RDd mod1 rep <. NS IN>
Aug 8 11:22:25 celje unbound: [6762:0] debug: cache memory msg=61171 rrset=79120 infra=15616 val=47544
Aug 8 11:22:25 celje unbound: [6762:0] debug: answer cb
Aug 8 11:22:25 celje unbound: [6762:0] debug: Incoming reply id = 819b
Aug 8 11:22:25 celje unbound: [6762:0] debug: Incoming reply addr = ip4 192.5.5.241 port 53 (len 16)
Aug 8 11:22:25 celje unbound: [6762:0] debug: lookup size is 1 entries
Aug 8 11:22:25 celje unbound: [6762:0] debug: received udp reply.
Aug 8 11:22:25 celje unbound: [6762:0] debug: udp message[857:0] 819B84100001000E00000017000002000100000200010007E9000014016D0C726F6F742D73657276657273036E65740000000200010007E9000004016AC01E00000200010007E90000040165C01E00000200010007E90000040164C01E00000200010007E90000040168C01E00000200010007E90000040161C01E00000200010007E90000040162C01E00000200010007E90000040167C01E00000200010007E90000040166C01E00000200010007E90000040163C01E00000200010007E90000040169C01E00000200010007E9000004016CC01E00000200010007E9000004016BC01E00002E00010007E9000093000208000007E9004E4861804E3F18F099
Aug 8 11:22:25 celje unbound: [6762:0] debug: udp message[857:256] 730086C8445044F339B9B29EDD9AE4EF3EDE8F6F261EA971E99DC239868B929FC29190F433B5FB3B80BC226AF8979B9BA489B41F96F6416B718F5071B3690DC5DAB6CC01F311AC3BE38DEFA13583B4938A085832B9D4B7A1D71C65C1D4F73FA3A09912ECF6149EE1C5273117A63C0AEAD24C0E700B780DCCB6F7719E959EAA84D34EC077000100010036EE800004C6290004C086000100010036EE800004C0E44FC9C0B3000100010036EE800004C021040CC059000100010036EE80000480080A5AC04A000100010036EE800004C0CBE60AC0A4000100010036EE800004C00505F1C095000100010036EE800004C0702404C068000100010036EE800004803F
Aug 8 11:22:25 celje unbound: [6762:0] debug: udp message[857:512] 0235C0C2000100010036EE800004C0249411C03B000100010036EE800004C03A801EC0E0000100010036EE800004C1000E81C0D1000100010036EE800004C707532AC01C000100010036EE800004CA0C1B21C077001C00010036EE80001020010503BA3E00000000000000020030C059001C00010036EE80001020010500002D0000000000000000000DC0A4001C00010036EE80001020010500002F0000000000000000000FC068001C00010036EE800010200105000001000000000000803F0235C0C2001C00010036EE800010200107FE000000000000000000000053C03B001C00010036EE800010200105030C2700000000000000020030C0E0001C0001
Aug 8 11:22:25 celje unbound: [6762:0] debug: udp message[857:768] 0036EE800010200107FD000000000000000000000001C0D1001C00010036EE80001020010500000300000000000000000042C01C001C00010036EE80001020010DC30000000000000000000000350000291000000080000000
Aug 8 11:22:25 celje unbound: [6762:0] debug: outnet handle udp reply
Aug 8 11:22:25 celje unbound: [6762:0] debug: measured roundtrip at 57 msec
Aug 8 11:22:25 celje unbound: [6762:0] debug: svcd callbacks start
Aug 8 11:22:25 celje unbound: [6762:0] debug: worker svcd callback for qstate 0x944eef8
Aug 8 11:22:25 celje unbound: [6762:0] debug: mesh_run: start
Aug 8 11:22:25 celje unbound: [6762:0] debug: iterator[module 1] operate: extstate:module_wait_reply event:module_event_reply
Aug 8 11:22:25 celje unbound: [6762:0] info: iterator operate: query <. NS IN>
Aug 8 11:22:25 celje unbound: [6762:0] debug: process_response: new external response event
Aug 8 11:22:25 celje unbound: [6762:0] info: scrub for <. NS IN>
Aug 8 11:22:25 celje unbound: [6762:0] info: response for <. NS IN>
Aug 8 11:22:25 celje unbound: [6762:0] info: reply from <.> 192.5.5.241#53
Aug 8 11:22:25 celje unbound: [6762:0] info: incoming scrubbed packet: ;; ->>HEADER<<- opcode: QUERY, rcode: NOERROR, id: 0#012;; flags: qr aa ; QUERY: 1, ANSWER: 14, AUTHORITY: 0, ADDITIONAL: 22 #012;; QUESTION SECTION:#012;; .#011IN#011NS#012#012;; ANSWER SECTION:#012.#011518400#011IN#011NS#011m.root-servers.net.#012.#011518400#011IN#011NS#011j.root-servers.net.#012.#011518400#011IN#011NS#011e.root-servers.net.#012.#011518400#011IN#011NS#011d.root-servers.net.#012.#011518400#011IN#011NS#011h.root-servers.net.#012.#011518400#011IN#011NS#011a.root-servers.net.#012.#011518400#011IN#011NS#011b.root-servers.net.#012.#011518400#011IN#011NS#011g.root-servers.net.#012.#011518400#011IN#011NS#011f.root-servers.net.#012.#011518400#011IN#011NS#011c.root-servers.net.#012.#011518400#011IN#011NS#011i.root-servers.net.#012.#011518400#011IN#011NS#011l.root-servers.net.#012.#011518400#011IN#011NS#011k.root-servers.net.#012.#011518400#011IN#011RRSIG#011NS 8 0 518400 20110815000000 20110807230000 39283 . hshEUETzObmynt2a5O8+3o9vJh6pcemdwjmGi5KfwpGQ9DO1+zuAvCJq+Jebm6SJtB+W9kFrcY9QcbNpDcXatswB8xGsO+ON76E1g7STighYMrnUt6HXHGXB1Pc/o6CZEuz2FJ7hxScxF6Y8CurSTA5wC3gNzLb3cZ6VnqqE004= ;{id = 39283}#012#012;; AUTHORITY SECTION:#012#012;; ADDITIONAL SECTION:#012a.root-servers.net.#0113600000#011IN#011A#011198.41.0.4#012b.root-servers.net.#0113600000#011IN#011A#011192.228.79.201#012c.root-servers.net.#0113600000#011IN#011A#011192.33.4.12#012d.root-servers.net.#0113600000#011IN#011A#011128.8.10.90#012e.root-servers.net.#0113600000#011IN#011A#011192.203.230.10#012f.root-servers.net.#0113600000#011IN#011A#011192.5.5.241#012g.root-servers.net.#0113600000#011IN#011A#011192.112.36.4#012h.root-servers.net.#0113600000#011IN#011A#011128.63.2.53#012i.root-servers.net.#0113600000#011IN#011A#011192.36.148.17#012j.root-servers.net.#0113600000#011IN#011A#011192.58.128.30#012k.root-servers.net.#0113600000#011IN#011A#011193.0.14.129#012l.root-servers.net.#0113600000#011IN#011A#011199.7.83.42#012m.root-servers.net.#0113600000#011IN#011A#011202.12.27.33#012a.root-servers.net.#0113600000#011IN#011AAAA#0112001:503:ba3e::2:30#012d.root-servers.net.#0113600000#011IN#011AAAA#0112001:500:2d::d#012f.root-servers.net.#0113600000#011IN#011AAAA#0112001:500:2f::f#012h.root-servers.net.#0113600000#011IN#011AAAA#0112001:500:1::803f:235#012i.root-servers.net.#0113600000#011IN#011AAAA#0112001:7fe::53#012j.root-servers.net.#0113600000#011IN#011AAAA#0112001:503:c27::2:30#012k.root-servers.net.#0113600000#011IN#011AAAA#0112001:7fd::1#012l.root-servers.net.#0113600000#011IN#011AAAA#0112001:500:3::42#012m.root-servers.net.#0113600000#011IN#011AAAA#0112001:dc3::35#012#012;; Query time: 0 msec#012;; WHEN: Thu Jan 1 00:00:00 1970#012;; MSG SIZE rcvd: 846
Aug 8 11:22:25 celje unbound: [6762:0] debug: iter_handle processing q with state QUERY RESPONSE STATE
Aug 8 11:22:25 celje unbound: [6762:0] info: query response was ANSWER
Aug 8 11:22:25 celje unbound: [6762:0] debug: iter_handle processing q with state FINISHED RESPONSE STATE
Aug 8 11:22:25 celje unbound: [6762:0] info: finishing processing for <. NS IN>
Aug 8 11:22:25 celje unbound: [6762:0] debug: mesh_run: iterator module exit state is module_finished
Aug 8 11:22:25 celje unbound: [6762:0] debug: validator[module 0] operate: extstate:module_wait_module event:module_event_moddone
Aug 8 11:22:25 celje unbound: [6762:0] info: validator operate: query <. NS IN>
Aug 8 11:22:25 celje unbound: [6762:0] debug: validator: nextmodule returned
Aug 8 11:22:25 celje unbound: [6762:0] debug: val handle processing q with state VAL_INIT_STATE
Aug 8 11:22:25 celje unbound: [6762:0] debug: validator classification positive
Aug 8 11:22:25 celje unbound: [6762:0] info: signer is <. TYPE0 CLASS0>
Aug 8 11:22:25 celje unbound: [6762:0] debug: val handle processing q with state VAL_FINISHED_STATE
Aug 8 11:22:25 celje unbound: [6762:0] info: DLV init look <. DS IN>
Aug 8 11:22:25 celje unbound: [6762:0] info: DLV name <dlv.isc.org. DLV IN>
Aug 8 11:22:25 celje unbound: [6762:0] info: negcache dlvlookup <dlv.isc.org. DLV IN>
Aug 8 11:22:25 celje unbound: [6762:0] info: negcache zone <dlv.isc.org. TYPE0 IN>
Aug 8 11:22:25 celje unbound: [6762:0] info: negcache rr <dlv.isc.org. NSEC IN>
Aug 8 11:22:25 celje unbound: [6762:0] debug: negcache got secure rrset
Aug 8 11:22:25 celje unbound: [6762:0] debug: negcache DLV denial proven
Aug 8 11:22:25 celje unbound: [6762:0] debug: ask above dlv repo
Aug 8 11:22:25 celje unbound: [6762:0] debug: mesh_run: validator module exit state is module_finished
Aug 8 11:22:25 celje unbound: [6762:0] debug: query took 0.057046 sec
Aug 8 11:22:25 celje unbound: [6762:0] info: mesh_run: end 0 recursion states (0 with reply, 0 detached), 0 waiting replies, 4 recursion replies sent, 0 replies dropped, 0 states jostled out
Aug 8 11:22:25 celje unbound: [6762:0] info: average recursion processing time 20.990084 sec
Aug 8 11:22:25 celje unbound: [6762:0] info: histogram of recursion processing times
Aug 8 11:22:25 celje unbound: [6762:0] info: [25%]=0.032768 median[50%]=8 [75%]=16
Aug 8 11:22:25 celje unbound: [6762:0] info: lower(secs) upper(secs) recursions
Aug 8 11:22:25 celje unbound: [6762:0] info: 0.032768 0.065536 1
Aug 8 11:22:25 celje unbound: [6762:0] info: 16.000000 32.000000 2
Aug 8 11:22:25 celje unbound: [6762:0] info: 32.000000 64.000000 1
Aug 8 11:22:25 celje unbound: [6762:0] debug: cache memory msg=61539 rrset=79120 infra=15616 val=47544
Aug 8 11:22:25 celje unbound: [6762:0] debug: svcd callbacks end
Aug 8 11:22:25 celje unbound: [6762:0] debug: close of port 36419
Aug 8 11:22:25 celje unbound: [6762:0] debug: close fd 13
Sign up for free to join this conversation on GitHub. Already have an account? Sign in to comment