[Mar 14 20:34:22] DEBUG[28479] rtp.c: Sending dtmf: 35 (#), at 172.16.10.107
[Mar 14 20:34:22] DTMF[28479] channel.c: DTMF end '#' received on SIP/249-097fc248, duration 75 ms
[Mar 14 20:34:22] DTMF[28479] channel.c: DTMF end accepted with begin '#' on SIP/249-097fc248
[Mar 14 20:34:22] DTMF[28479] channel.c: DTMF end '#' has duration 75 but want minimum 80, emulating on SIP/249-097fc248
[Mar 14 20:34:22] DEBUG[28479] rtp.c: - RTP 2833 Event: 0000000b (len = 4)
[Mar 14 20:34:22] DTMF[28479] channel.c: DTMF end emulation of '#' queued on SIP/249-097fc248
[Mar 14 20:34:22] DEBUG[28479] rtp.c: Oooh, got a digit
[Mar 14 20:34:22] DEBUG[28479] channel.c: Returning from native bridge, channels: SIP/447-09802228, SIP/249-097fc248
[Mar 14 20:34:22] DEBUG[28479] res_features.c: Feature interpret: chan=SIP/447-09802228, peer=SIP/249-097fc248, sense=2, features=16 dynamic=(null)
[Mar 14 20:34:22] DEBUG[28480] rtp.c: - RTP 2833 Event: 0000000b (len = 4)
[Mar 14 20:34:22] VERBOSE[28479] logger.c:     -- Packet2Packet bridging SIP/447-09802228 and SIP/249-097fc248
[Mar 14 20:34:22] DEBUG[28455] chan_iax2.c: Allocate call number
[Mar 14 20:34:22] DEBUG[28455] chan_iax2.c: Registration created on call 12
[Mar 14 20:34:22] DEBUG[28456] chan_iax2.c: Allocate call number
[Mar 14 20:34:22] DEBUG[28456] chan_iax2.c: Registration created on call 13
[Mar 14 20:34:22] DEBUG[28459] chan_iax2.c: Allocate call number
[Mar 14 20:34:22] DEBUG[28459] chan_iax2.c: Registration created on call 14
[Mar 14 20:34:22] DEBUG[28460] chan_iax2.c: Allocate call number
[Mar 14 20:34:22] DEBUG[28460] chan_iax2.c: Registration created on call 15
[Mar 14 20:34:22] DEBUG[28461] chan_iax2.c: Allocate call number
[Mar 14 20:34:22] DEBUG[28461] chan_iax2.c: Registration created on call 16
[Mar 14 20:34:22] DEBUG[28479] rtp.c: - RTP 2833 Event: 00000009 (len = 4)
[Mar 14 20:34:22] DEBUG[28479] rtp.c: Sending dtmf: 57 (9), at 172.16.10.107
[Mar 14 20:34:22] DTMF[28479] channel.c: DTMF begin '9' received on SIP/249-097fc248
[Mar 14 20:34:22] DTMF[28479] channel.c: DTMF begin passthrough '9' on SIP/249-097fc248
[Mar 14 20:34:22] DEBUG[28479] rtp.c: Oooh, got a digit
[Mar 14 20:34:22] DEBUG[28479] channel.c: Returning from native bridge, channels: SIP/447-09802228, SIP/249-097fc248
[Mar 14 20:34:22] VERBOSE[28479] logger.c:     -- Packet2Packet bridging SIP/447-09802228 and SIP/249-097fc248
[Mar 14 20:34:23] DEBUG[28479] rtp.c: - RTP 2833 Event: 00000009 (len = 4)
[Mar 14 20:34:23] DEBUG[28479] rtp.c: - RTP 2833 Event: 00000009 (len = 4)
[Mar 14 20:34:23] DEBUG[28479] rtp.c: - RTP 2833 Event: 00000009 (len = 4)
[Mar 14 20:34:23] DEBUG[28472] chan_sip.c: Auto destroying SIP dialog '001b2a20-ae450003-b90d1329-45ce1476@172.16.10.113'
[Mar 14 20:34:23] DEBUG[28472] chan_sip.c: Destroying SIP dialog 001b2a20-ae450003-b90d1329-45ce1476@172.16.10.113
[Mar 14 20:34:23] VERBOSE[28472] logger.c: Really destroying SIP dialog '001b2a20-ae450003-b90d1329-45ce1476@172.16.10.113' Method: REGISTER
[Mar 14 20:34:23] DEBUG[28479] rtp.c: - RTP 2833 Event: 00000009 (len = 4)
[Mar 14 20:34:23] DEBUG[28479] rtp.c: - RTP 2833 Event: 00000009 (len = 4)
[Mar 14 20:34:23] DEBUG[28479] rtp.c: Sending dtmf: 57 (9), at 172.16.10.107
[Mar 14 20:34:23] DTMF[28479] channel.c: DTMF end '9' received on SIP/249-097fc248, duration 85 ms
[Mar 14 20:34:23] DTMF[28479] channel.c: DTMF end accepted with begin '9' on SIP/249-097fc248
[Mar 14 20:34:23] DTMF[28479] channel.c: DTMF end passthrough '9' on SIP/249-097fc248
[Mar 14 20:34:23] DEBUG[28479] rtp.c: Oooh, got a digit
[Mar 14 20:34:23] DEBUG[28479] channel.c: Returning from native bridge, channels: SIP/447-09802228, SIP/249-097fc248
[Mar 14 20:34:23] DEBUG[28479] res_features.c: Feature interpret: chan=SIP/447-09802228, peer=SIP/249-097fc248, sense=2, features=16 dynamic=(null)
[Mar 14 20:34:23] DEBUG[28480] rtp.c: - RTP 2833 Event: 00000009 (len = 4)
[Mar 14 20:34:23] DEBUG[28480] rtp.c: - RTP 2833 Event: 00000009 (len = 4)
[Mar 14 20:34:23] VERBOSE[28479] logger.c:     -- Packet2Packet bridging SIP/447-09802228 and SIP/249-097fc248