debug dsp-resource-manager flex all

Sep 20 10:10:40.903: flex_dsprm_vtsp_open
Sep 20 10:10:40.903: flex_dsprm_dspfm_dsp_open:resId=0x1,service_id=2 (1-mtp,2-x
code,4-conf)
Sep 20 10:10:40.903: flex_dsprm_dspfm_find_free_dsp_channel
Sep 20 10:10:40.903: flex_dsprm_dspfm_open_and_set_dsp_chnl
Sep 20 10:10:40.903: flex_dsprm_dspfm_open_and_set_dsp_chnl: dsp(0/2), channel(0
), credit(0)
Sep 20 10:10:40.903: flex_dsprm_dspfm_find_free_dsp_channel: return dsp_channel(
0/2/0)
Sep 20 10:10:40.903: C5510 DPR3: H2D Msg: 0010 0001 004A 016E 0000 0000 FFFF 000
0
Sep 20 10:
londrtr1#10:40.931: C5510 DPR3: H2D Msg: 0008 0001 004B 0179
Sep 20 10:10:40.931: flex_dsprm_vtsp_close
Sep 20 10:10:40.931: flex_dsprm_dspfm_dsp_close: resId=0x1, service_id=2
Sep 20 10:10:40.931: flex_dsprm_dspfm_return_dsp_credit: dsp=0/2 channel=0 credi
t=40

londrtr1#debug sccp errors
Skinny Client Control Protocol errors debugging is on
londrtr1#
Sep 20 10:11:50.616: sym_xapp_xlate_sccp_codec: payload 16
Sep 20 10:11:50.624: sym_xapp_xlate_sccp_codec: payload 4

debug sccp events
Sep 20 10:12:49.857: sym_xapp_create_conn_if_ok: creating new conn_cb for sess_i
d 33586456, conn_id 50331666
Sep 20 10:12:49.857: sym_xapp_create_and_init_conn_cb: glob_ccm->version 7
Sep 20 10:12:49.857:  sccp_extract_and_validate_srtp_context
Sep 20 10:12:49.857: sym_xapp_find_peer_conn_cb: conn_cb->sess_cb is NULL
Sep 20 10:12:49.857: sym_xapp_open_receive_chnl agreed_sccp_ver=15, dtmf_method=
10, rx_PT=0 conn_info->local_ipaddr=10.192.7.2 conn_info->remote_ipaddr=0.0.0.0
Sep 20 10:12:49.857: sym_xapp_open_receive_chnl: sess_id 33586456, conn_id 50331
666, codec 16, pkt_period 20, sess_type 2, mixed_mode 0, mm_codec 0, mm_pkt_peri
od 0, stream_passthr_id 16777216, rcv_dtmf_payload_type 101, snd_dtmf_payload_ty
pe 101, codec_mode 0, rx_dynamic_pt 0, tx_dynamic_pt 0, amr_bitmap 0
Sep 20 10:12:49.857: sym_xapp_search_for_conn_cb: sess_id is ZERO to conn_cbconn
_id 50331666
Sep 20 10:12:49.857: sym_xapp_add_and_initiate_conn_setup: adding conn_cb for se
ss_id 33586456 conn_id 50331666
Sep 20 10:12:49.857: sym_xapp_add_conn_cb: Create sess_cb as conn_id 50331666 is
 the  first conn for sess_id 33586456
Sep 20 10:12:49.857: sym_xapp_create_and_add_sess_cb: Add sess_cb (4B65D650) rec
ord, sess_id 33586456, sess_type 2, appl 4B8A1104, act_sess 1
Sep 20 10:12:49.857: sym_xapp_initiate_callegs_setup: port_reusable 0 rtp_clr 0x
0 msp_clr 0x0  msp_clr_ref 0, for sess_id 33586456 conn_id 50331666 stream_passt
hr_id 16777216
Sep 20 10:12:49.857: sym_xapp_initiate_callegs_setup: RTP Calleg setup will be i
nitiated - sess_id 33586456, conn_id 50331666, calleg_type 1
Sep 20 10:12:49.857: sym_xapp_calleg_setup_req: open new port 17134
Sep 20 10:12:49.857: sym_xapp_calleg_setup_req: Info provided to RTPSPI - rtp_se
ss_mode 2
 desired_qos 0, codec 13, pkt_period 20,
 lr_ipaddr 10.192.7.2, lr_port 17134,
 vad 0, iptos 0, rmt_ipaddr 0.0.0.0, rmt_port 0,
for sess_id 33586456, conn_id 50331666, stream_passthr_id 16777216
Sep 20 10:12:49.857: sccp_get_bind_intf_vrf_id: bind vrf id is 0 for appl type 2
, profile 1
Sep 20 10:12:49.857: sym_xapp_calleg_setup_req: Call setup req made for sess_id
33586456, conn_id 50331666, call_id 199, calleg_type 1, msp_type 0
Sep 20 10:12:49.857: sym_xapp_initiate_callegs_setup: Non-SWMTP handling for app
l_type 2, sess_type 2 sess_id 33586456, conn_id 50331666, current count 1
Sep 20 10:12:49.857: sym_xapp_initiate_msp_calleg_setup: MSP Calleg setup will b
e initiated - sess_id 33586456, conn_id 50331666, calleg_type 2, msp_type 2
Sep 20 10:12:49.857: sym_xapp_calleg_setup_req: Call setup req made for sess_id
33586456, conn_id 50331666, call_id 200, calleg_type 2, msp_type 2
Sep 20 10:12:49.865: sym_xapp_search_for_conn_cb: sess_cb 4B65D650, sess_id 3358
6456, conn_id 50331668
Sep 20 10:12:49.865: sym_xapp_create_conn_if_ok: creating new conn_cb for sess_i
d 33586456, conn_id 50331668
Sep 20 10:12:49.865: sym_xapp_create_and_init_conn_cb: glob_ccm->version 7
Sep 20 10:12:49.865:  sccp_extract_and_validate_srtp_context
Sep 20 10:12:49.865: sym_xapp_find_peer_conn_cb: find possible peer_conn_cb, for

 cur conn_cb: sess_id 33586456 conn_id 50331668 stream_passthr_id 16777216
 peer: sess_id 33586456 conn_id 50331666 stream_passthr_id 16777216, conn_mode 2
 rtp_clr 0x4789DF3C
Sep 20 10:12:49.865: sym_xapp_find_peer_conn_cb: found peer_conn_cb, rtp_clr sta
te 1
Sep 20 10:12:49.865: sym_xapp_open_receive_chnl agreed_sccp_ver=15, dtmf_method=
10, rx_PT=0 conn_info->local_ipaddr=10.192.7.2 conn_info->remote_ipaddr=0.0.0.0
Sep 20 10:12:49.869: sym_xapp_open_receive_chnl: sess_id 33586456, conn_id 50331
668, codec 4, pkt_period 20, sess_type 2, mixed_mode 0, mm_codec 0, mm_pkt_perio
d 0, stream_passthr_id 16777216, rcv_dtmf_payload_type 101, snd_dtmf_payload_typ
e 101, codec_mode 0, rx_dynamic_pt 0, tx_dynamic_pt 0, amr_bitmap 0
Sep 20 10:12:49.869: sym_xapp_search_for_conn_cb: sess_cb 4B65D650, sess_id 3358
6456, conn_id 50331668
Sep 20 10:12:49.869: sym_xapp_add_and_initiate_conn_setup: adding conn_cb for se
ss_id 33586456 conn_id 50331668
Sep 20 10:12:49.869: sym_xapp_add_conn_cb: conn_cb added, sess_id 33586456, conn
_id 50331668
Sep 20 10:12:49.869: sym_xapp_initiate_callegs_setup: port_reusable 0 rtp_clr 0x
0 msp_clr 0x0  msp_clr_ref 0, for sess_id 33586456 conn_id 50331668 stream_passt
hr_id 16777216
Sep 20 10:12:49.869: sym_xapp_initiate_callegs_setup: RTP Calleg setup will be i
nitiated - sess_id 33586456, conn_id 50331668, calleg_type 1
Sep 20 10:12:49.869: sym_xapp_find_peer_conn_cb: find possible peer_conn_cb, for

 cur conn_cb: sess_id 33586456 conn_id 50331668 stream_passthr_id 16777216
 peer: sess_id 33586456 conn_id 50331666 stream_passthr_id 16777216, conn_mode 2
 rtp_clr 0x4789DF3C
Sep 20 10:12:49.869: sym_xapp_find_peer_conn_cb: found peer_conn_cb, rtp_clr sta
te 1
Sep 20 10:12:49.869: sym_xapp_calleg_setup_req: open new port 17792
Sep 20 10:12:49.869: sym_xapp_calleg_setup_req: Info provided to RTPSPI - rtp_se
ss_mode 2
 desired_qos 0, codec 5, pkt_period 20,
 lr_ipaddr 10.192.7.2, lr_port 17792,
 vad 0, iptos 0, rmt_ipaddr 0.0.0.0, rmt_port 0,
for sess_id 33586456, conn_id 50331668, stream_passthr_id 16777216
Sep 20 10:12:49.869: sccp_get_bind_intf_vrf_id: bind vrf id is 0 for appl type 2
, profile 1
Sep 20 10:12:49.869: sym_xapp_calleg_setup_req: Call setup req made for sess_id
33586456, conn_id 50331668, call_id 201, calleg_type 1, msp_type 0
Sep 20 10:12:49.869: sym_xapp_initiate_callegs_setup: Non-SWMTP handling for app
l_type 2, sess_type 2 sess_id 33586456, conn_id 50331668, current count 2
Sep 20 10:12:49.873: sym_xapp_process_ccapi_events: state 1, eve_id 1, call_id 2
00
Sep 20 10:12:49.877: sym_xapp_calleg_connected: Calleg connected for sess_id 335
86456 conn_id 50331666  call_id 200 calleg_type 2
Sep 20 10:12:49.877: sym_xapp_calleg_bridge_req: bridge req for sevc_type 2 sess
_id 33586456 conn_id 50331666 codec 16 calleg_type 2
Sep 20 10:12:49.877: sym_xapp_bridge_transcoding_callegs: for sess_id 33586456 c
onn_id 50331666 stream_passthr_id 16777216  calleg_type 2
Sep 20 10:12:49.877: sym_xapp_bridge_waiting_peer_callegs: Not ready or no need
to bridge this rtp_clr sess_id 33586456, conn_id 50331666
Sep 20 10:12:49.877: sym_xapp_bridge_waiting_peer_callegs: Not ready or no need
to bridge this rtp_clr sess_id 33586456, conn_id 50331668
Sep 20 10:12:49.877: sym_xapp_process_ccapi_events: state 1, eve_id 1, call_id 1
99
Sep 20 10:12:49.877: sym_xapp_calleg_connected: Calleg connected for sess_id 335
86456 conn_id 50331666  call_id 199 calleg_type 1
Sep 20 10:12:49.877: sym_xapp_calleg_bridge_req: bridge req for sevc_type 2 sess
_id 33586456 conn_id 50331666 codec 16 calleg_type 1
Sep 20 10:12:49.877: sym_xapp_bridge_transcoding_callegs: for sess_id 33586456 c
onn_id 50331666 stream_passthr_id 16777216  calleg_type 1
Sep 20 10:12:49.877: sym_xapp_bridge_two_callegs: Bridge MSP & RTP callegs sess_
id 33586456, conn_id 50331666, msp_call_id 200, rtp_call_id 199 sym_codec 1000,
codec_by
londrtr1#tes 20, sym_vad 1 rcv_nte_payload 101, snd_nte_payload 101 dtmf_method
rfc2833_pthru codec_mode 0, tx_dynamic_pt 128 rx_dynamic_pt 128, amr_bitmap 0
Sep 20 10:12:49.877: sym_xapp_process_ccapi_events: state 1, eve_id 1, call_id 2
01
Sep 20 10:12:49.877: sym_xapp_calleg_connected: Calleg connected for sess_id 335
86456 conn_id 50331668  call_id 201 calleg_type 1
Sep 20 10:12:49.877: sym_xapp_calleg_bridge_req: bridge req for sevc_type 2 sess
_id 33586456 conn_id 50331668 codec 4 calleg_type 1
Sep 20 10:12:49.877: sym_xapp_bridge_transcoding_callegs: for sess_id 33586456 c
onn_id 50331668 stream_passthr_id 16777216  calleg_type 1
Sep 20 10:12:49.877: sym_xapp_bridge_two_callegs: Bridge MSP & RTP callegs sess_
id 33586456, conn_id 50331668, msp_call_id 200, rtp_call_id 201 sym_codec 1, cod
ec_bytes 160, sym_vad 1 rcv_nte_payload 101, snd_nte_payload 101 dtmf_method rfc
2833_pthru codec_mode 0, tx_dynamic_pt 128 rx_dynamic_pt 128, amr_bitmap 0
Sep 20 10:12:49.877: sym_xapp_process_ccapi_events: state 3, eve_id 7, call_id 1
99
Sep 20 10:12:49.877: sym_xapp_calle
londrtr1#g_bridge_success: bridge success for sess_id 33586456 conn_id 50331666
Sep 20 10:12:49.877: sym_xapp_calleg_bridge_success: Send ack to CCM for sess_id
 33586456, conn_id 50331666, local_ipaddr 10.192.7.2, lport 17134
Sep 20 10:12:49.877: sccp_open_receive_chnl_ack_v1: going to send ack to CCM - s
tatus 0, ipaddr 10.192.7.2, port 17134, conn_id 50331666, prof_id 1
Sep 20 10:12:49.877: sym_xapp_calleg_bridge_success: Checking for pending subscr
ibe request.
Sep 20 10:12:49.877: sym_xapp_check_pending_subscribe_req: No pending dtmf subsc
ribe req.
Sep 20 10:12:49.877: sym_xapp_calleg_bridge_success: Bridge done for bridge_cnt
1, bridge_id 133, call1_id 199, calleg1_type 1, call2_id 200, calleg2_type 2, se
ss_id 33586456, conn_id 50331666
Sep 20 10:12:49.885: sym_xapp_process_ccapi_events: state 3, eve_id 7, call_id 2
01
Sep 20 10:12:49.885: sym_xapp_calleg_bridge_success: bridge success for sess_id
33586456 conn_id 50331668
Sep 20 10:12:49.885: sym_xapp_calleg_bridge_success: Send ack to CCM for sess_id
 33586456, conn_id 50331668, local_ipaddr 10.192.7.2, lport 17792
Sep 20 10:12:49.885: sccp_open_receive_chnl_ack_v1: going to send ack to CCM - s
tatus 0, ipaddr 10.192.7.2, port 17792, conn_id 50331668, prof_id 1
Sep 20 10:12:49.885: sym_xapp_calleg_bridge_success: Checking for pending subscr
ibe request.
Sep 20 10:12:49.885: sym_xapp_check_pending_subscribe_req: No pending dtmf subsc
ribe req.
Sep 20 10:12:49.885: sym_xapp_calleg_bridge_success: Bridge done for bridge_cnt
2, bridge_id 134, call1_id 201, calleg1_type 1, call2_id 200, calleg2_type 2, se
ss_id 33586456, conn_id 50331668
Sep 20 10:12:49.885: sym_xapp_process_ccapi_events: state 4, eve_id 4, call_id 1
99
Sep 20 10:12:49.885: sym_xapp_calleg_modify_success: Call modify success for ses
s_id 33586456, conn_id 50331666, call_id 199
Sep 20 10:12:49.885: sym_xapp_suppress_cisco_resv_payload:
Sep 20 10:12:49.889: sym_xapp_search_for_conn_cb: sess_cb 4B65D650, sess_id 3358
6456, conn_id 50331666
Sep 20 10:12:49.889: sym_xapp_close_receive_chnl: sess_id 33586456, conn_id 5033
1666, cmode 1, nmode 1, event 11
Sep 20 10:12:49.889: sym_xapp_calleg_bridg
londrtr1#e_destroy: for sess_type 2 sess_id 33586456 conn_id 50331666
Sep 20 10:12:49.889: sym_xapp_calleg_bridge_destroy: Bridge destroy initiated -
bridge_cnt 2, sess_id 33586456, conn_id 50331666, bridge_id 133, call1_id 199, c
all1_type 1, call2_id 200, call2_type 2, msp_clr_ref 1
Sep 20 10:12:49.889: sym_xapp_search_for_conn_cb: sess_cb 4B65D650, sess_id 3358
6456, conn_id 50331668
Sep 20 10:12:49.889: sym_xapp_close_receive_chnl: sess_id 33586456, conn_id 5033
1668, cmode 1, nmode 1, event 11
Sep 20 10:12:49.889: sym_xapp_calleg_bridge_destroy: for sess_type 2 sess_id 335
86456 conn_id 50331668
Sep 20 10:12:49.889: sym_xapp_calleg_bridge_destroy: Bridge destroy initiated -
bridge_cnt 2, sess_id 33586456, conn_id 50331668, bridge_id 134, call1_id 201, c
all1_type 1, call2_id 200, call2_type 2, msp_clr_ref 0
Sep 20 10:12:49.889: sym_xapp_process_ccapi_events: state 6, eve_id 4, call_id 2
01
Sep 20 10:12:49.893: sym_xapp_calleg_modify_success: Call modify success for ses
s_id 33586456, conn_id 50331668, call_id 201
Sep 20 10:12:49.893: sym_xapp_suppress_cisco_resv_payload:
Sep 20 10:12:49.893: sym_xapp_process_ccapi_events: state 6, eve_id 13, call_id
199
Sep 20 10:12:49.893: sym_xapp_calleg_bridge_destroyed: Bridge destroyed - sess_i
d 33586456, conn_id 50331666, bridge_id 0, call1_id 199, call1_type 1, bridge_cn
t 1, msp_clr_ref 1
Sep 20 10:12:49.893: sym_xapp_disconnect_calleg: Disconnecting calleg - sess_id
33586456, conn_id 50331666, calleg_id 199, calleg_type 1, state 7
Sep 20 10:12:49.893: sym_xapp_calleg_disconnect_req: ccCallDisconnect made - ses
s_id 33586456, conn_id 50331666, calleg_id 199, calleg_type 1, state 8
Sep 20 10:12:49.893: sym_xapp_process_ccapi_events: state 6, eve_id 13, call_id
201
Sep 20 10:12:49.893: sym_xapp_calleg_bridge_destroyed: Bridge destroyed - sess_i
d 33586456, conn_id 50331668, bridge_id 0, call1_id 201, call1_type 1, bridge_cn
t 0, msp_clr_ref 0
Sep 20 10:12:49.893: sym_xapp_disconnect_calleg: Disconnecting calleg - sess_id
33586456, conn_id 50331668, calleg_id 201, calleg_type 1, state 7
Sep 20 10:12:49.893: sym_xapp_calleg_disconnect_req: ccCallDisconnect made - ses
s_id 33586456, conn_id 50331668, calleg_id 201, calleg_type 1, state 8
Sep 20 10:12:49.905: sym_xapp_process_ccapi_events: state 8, eve_id 14, call_id
199
Sep 20 10:12:49.905: sym_xapp_calleg_disconnected: Calleg disonnected - sess_id
33586456, conn_id 50331666, calleg_id 199, calleg_type 1
Sep 20 10:12:49.905: sym_xapp_transcoding_calleg_disconnected: for sess_id 33586
456 conn_id 50331666 stream_passthr_id 16777216 calleg_type 1 msp_calleg_ref 1
Sep 20 10:12:49.905: sym_xapp_disconnect_msp_calleg_if_needed: sess_id 33586456,
 conn_id 50331666 str_passthr_id 16777216,  rtp_clr 0x0, msp_clr 0x4789DFB0, mm_
msp_clr 0x0 peer_conn_cb 0x4B8FB544
Sep 20 10:12:49.905: sym_xapp_transfer_conn_cb_reference: MSP clr transfer ref i
n sess_id 33586456,
 from cur conn_cb 0x4B8FB470, conn_id 50331666, stream_passthr_id 16777216,
 to peer  conn_cb 0x4B8FB544, conn_id 50331668, stream_passthr_id 16777216
Sep 20 10:12:49.905: sym_xapp_clear_conn_cb: conn_cb with sess_id 33586456, conn
_id 50331666, sess_cnt 2 - is being removed
Sep 20 10:12:49.905: sym_xapp_clear_rsvp:
Sep 20 10:12:49.905: sym_xapp_process_ccapi_events: state 8, eve_id 14, call_id
201
Sep 20 10:12:49.905: sym_xapp_calleg_disconnected: Calleg disonnected - sess_id
33586456, conn_id 50331668, calleg_id 201, calleg_type 1
Sep 20 10:12:49.905: sym_xapp_transcoding_calleg_disconnected: for sess_id 33586
456 conn_id 50331668 stream_passthr_id 16777216 calleg_type 1 msp_calleg_ref 1
Sep 20 10:12:49.905: sym_xapp_disconnect_msp_calleg_if_needed: sess_id 33586456,
 conn_id 50331668 str_passthr_id 16777216,  rtp_clr 0x0, msp_clr 0x4789DFB0, mm_
msp_clr 0x0 peer_conn_cb 0x0
Sep 20 10:12:49.905: sym_xapp_transfer_conn_cb_reference: conn_cb->peer_conn_cb
is NULL, for  sess_id 33586456, conn_id 50331668, stream_passthr_id 16777216
Sep 20 10:12:49.909: sym_xapp_disconnect_msp_calleg_if_needed: disconnecting MSP
 calleg for sess_id 33586456 conn_id 50331668 str_passthr_id 16777216
Sep 20 10:12:49.909: sym_xapp_disconnect_msp_calleg_if_needed: Since this is the
 last connection disconnect the MSP calleg - call_id 200
Sep 20 10:12:49.909: sym_xapp_disconnect_calleg: D
londrtr1#isconnecting calleg - sess_id 33586456, conn_id 50331668, calleg_id 200
, calleg_type 2, state 7
Sep 20 10:12:49.909: sym_xapp_calleg_disconnect_req: ccCallDisconnect made - ses
s_id 33586456, conn_id 50331668, calleg_id 200, calleg_type 2, state 8
Sep 20 10:12:49.909: sym_xapp_process_ccapi_events: state 8, eve_id 14, call_id
200
Sep 20 10:12:49.909: sym_xapp_calleg_disconnected: Calleg disonnected - sess_id
33586456, conn_id 50331668, calleg_id 200, calleg_type 2
Sep 20 10:12:49.909: sym_xapp_transcoding_calleg_disconnected: for sess_id 33586
456 conn_id 50331668 stream_passthr_id 16777216 calleg_type 2 msp_calleg_ref 1
Sep 20 10:12:49.909: sym_xapp_clear_conn_cb: conn_cb with sess_id 33586456, conn
_id 50331668, sess_cnt 1 - is being removed
Sep 20 10:12:49.909: sym_xapp_clear_rsvp:
Sep 20 10:12:49.909: sym_xapp_clear_sess_cb: act_sess 0, act_conns 0, sess_id 33
586456, appl_type 2
Sep 20 10:12:49.909: sccp_check_for_swo_swb_and_tear_down: All connections are c
leared - profile_id 1, appl_type 2, state 6, swo_init 0, swb_init 0
londrtr1#

debug voip ccapi all

Sep 20 10:13:46.607: //202/xxxxxxxxxxxx/CCAPI/ccIFCallSetupRequestPrivate:
   SPI Call Setup Request Is Success; Interface Type=9, FlowMode=1
Sep 20 10:13:46.607: //202/xxxxxxxxxxxx/CCAPI/ccCallSetContext:
   Context=0x4789866C
Sep 20 10:13:46.607: //-1/xxxxxxxxxxxx/CCAPI/ccIFCallSetupRequestPrivate:
   Interface=0x48A57CE4, Interface Type=25, Destination=, Mode=0x0,
   Call Params(Calling Number=,(Calling Name=)(TON=Unknown, NPI=Unknown, Screeni
ng=Not Screened, Presentation=Allowed),
   Called Number=(TON=Unknown, NPI=Unknown), Calling Translated=FALSE,
   Subscriber Type Str=, FinalDestinationFlag=FALSE, Outgoing Dial-peer=0, Call
Count On=FALSE,
   Source Trkgrp Route Label=, Target Trkgrp Route Label=, tg_label_flag=0, Appl
ication Call Id=)
Sep 20 10:13:46.607: //203/xxxxxxxxxxxx/CCAPI/cc_insert_call_entry:
   Total Call Count=0, Call Entry(Call Count On=FALSE, Incoming Call=FALSE)
Sep 20 10:13:46.607: //-1/xxxx
londrtr1#xxxxxxxx/CCAPI/cc_get_feature_vsa:

Sep 20 10:13:46.607: :cc_get_feature_vsa malloc success
Sep 20 10:13:46.607: //-1/xxxxxxxxxxxx/CCAPI/cc_get_feature_vsa:

Sep 20 10:13:46.607:  cc_get_feature_vsa count is 2
Sep 20 10:13:46.607: //-1/xxxxxxxxxxxx/CCAPI/cc_get_feature_vsa:

Sep 20 10:13:46.607: :FEATURE_VSA attributes are: feature_name:0,feature_time:12
65330872,feature_id:203
Sep 20 10:13:46.607: //-1/xxxxxxxxxxxx/CCAPI/cc_init_call_entry:

Sep 20 10:13:46.607:  call_init_entry calle is 478AE808,callid is 203
Sep 20 10:13:46.607: //203/xxxxxxxxxxxx/CCAPI/cc_insert_guid_pod_entry:
   Incoming=FALSE, Call Id=203
Sep 20 10:13:46.607: //0/xxxxxxxxxxxx/CCAPI/cc_get_call_entry:
   Call Entry Is Not Found
Sep 20 10:13:46.607: //203/xxxxxxxxxxxx/CCAPI/cc_api_call_connected:
   Interface=0x48A57CE4, Data Bitmask=0x0, Progress Indication=NULL(0),
   Connection Handle=0
Sep 20 10:13:46.607: //-1/xxxxxxxxxxxx/CCAPI/cc_set_conf_start_tstamp:
   CALL_ERROR_INFORMATIONAL;
Sep 20 10:13:46.607:  cc_set_conf_start_tstamp: no confID set - confID:0

Sep 20 10:13:46.607: //203/xxxxxxxxxxxx/CCAPI/cc_api_call_connected:
   Call Entry(Connected=TRUE, Responsed=TRUE, Retry Count=0)
Sep 20 10:13:46.607: //203/xxxxxxxxxxxx/CCAPI/cc_api_call_connected:exit@5774
Sep 20 10:13:46.607: //203/xxxxxxxxxxxx/CCAPI/ccIFCallSetupRequestPrivate:
   SPI Call Setup Request Is Success; Interface Type=25, FlowMode=1
Sep 20 10:13:46.607: //203/xxxxxxxxxxxx/CCAPI/ccCallSetContext:
   Context=0x478985F8
Sep 20 10:13:46.607: //202/xxxxxxxxxxxx/CCAPI/cc_api_call_connected:
   Interfac
londrtr1#e=0x4912D9FC, Data Bitmask=0x0, Progress Indication=NULL(0),
   Connection Handle=0
Sep 20 10:13:46.607: //-1/xxxxxxxxxxxx/CCAPI/cc_set_conf_start_tstamp:
   CALL_ERROR_INFORMATIONAL;
Sep 20 10:13:46.607:  cc_set_conf_start_tstamp: no confID set - confID:0

Sep 20 10:13:46.607: //202/xxxxxxxxxxxx/CCAPI/cc_api_call_connected:
   Call Entry(Connected=TRUE, Responsed=TRUE, Retry Count=0)
Sep 20 10:13:46.607: //202/xxxxxxxxxxxx/CCAPI/cc_api_call_connected:exit@5774
Sep 20 10:13:46.611: //202/xxxxxxxxxxxx/CCAPI/cc_incr_if_call_volume:
   Remote IP Address=0.0.0.0, Hwidb=GigabitEthernet0/1
Sep 20 10:13:46.611: //202/xxxxxxxxxxxx/CCAPI/cc_incr_if_call_volume:
   Total Call Count=1, Voip Call Count=1, MMoip Call Count=0
Sep 20 10:13:46.615: //-1/xxxxxxxxxxxx/CCAPI/ccIFCallSetupRequestPrivate:
   Interface=0x4912D9FC, Interface Type=9, Destination=0.0.0.0, Mode=0x0,
   Call Params(Calling Number=,(Calling Name=)(TON=Unknown, NPI=Unknown, Screeni
ng=Not Screened, Presentation=Allowed),
   Called Number=(TON=Unknown, NPI=Unknown), Calling Translated=FALSE,
   Subscriber Type Str=, FinalDestinationFlag=FALSE, Outgoing Dial-peer=0, Call
Count On=FALSE,
   Source Trkgrp Route Label=, Target Trkgrp Route Label=, tg_label_flag=0, Appl
ication Call Id=)
Sep 20 10:13:46.615: //204/xxxxxxxxxxxx/CCAPI/cc_insert_call_entry:
   Total Call Count=0, Call Entry(Call Count On=FALSE, Incoming Call=FALSE)
Sep 20 10:13:46.615: //-1/xxxxxxxxxxxx/CCAPI/cc_get_feature_vsa:

Sep 20 10:13:46.615: :cc_get_feature_vsa malloc success
Sep 20 10:13:46.615: //-1/xxxxxxxxxxxx/CCAPI/cc_get_feature_vsa:

Sep 20 10:13:46.615:  cc_get_feature_vsa count is 3
Sep 20 10:13:46.615: //-1/xxxxxxxxxxxx/CCAPI/cc_get_feature_vsa:

Sep 20 10:13:46.615: :FEATURE_VSA attributes are: feature_name:0,feature_time:12
65330648,feature_id:204
Sep 20 10:13:46.615: //-1/xxxxxxxxxxxx/CCAPI/cc_init_call_entry:

Sep 20 10:13:46.615:  call_init_entry calle is 478AFFB8,callid is 204
Sep 20 10:13:46.615: //204/xxxxxxxxxxxx/CCAPI/cc_insert_guid_pod_entry:
   Incoming=FALSE, Call Id=204
Sep 20 10:13:46.615: //204/xxxxxxxxxxxx/CCAPI/cc
londrtr1#_set_voice_port_value:
   CC_IF_RTP: vad=0, modem_pro=0, modem_codec=0
Sep 20 10:13:46.615: //204/xxxxxxxxxxxx/CCAPI/cc_set_voice_port_value:
   CALL_ERROR_INFORMATIONAL; ccMGTGetIF is failed; Return Code=-1
Sep 20 10:13:46.615: //0/xxxxxxxxxxxx/CCAPI/cc_get_call_entry:
   Call Entry Is Not Found
Sep 20 10:13:46.615: //204/xxxxxxxxxxxx/CCAPI/ccIFCallSetupRequestPrivate:
   SPI Call Setup Request Is Success; Interface Type=9, FlowMode=1
Sep 20 10:13:46.619: //204/xxxxxxxxxxxx/CCAPI/ccCallSetContext:
   Context=0x478986E0
Sep 20 10:13:46.619: //204/xxxxxxxxxxxx/CCAPI/cc_api_call_connected:
   Interface=0x4912D9FC, Data Bitmask=0x0, Progress Indication=NULL(0),
   Connection Handle=0
Sep 20 10:13:46.619: //-1/xxxxxxxxxxxx/CCAPI/cc_set_conf_start_tstamp:
   CALL_ERROR_INFORMATIONAL;
Sep 20 10:13:46.619:  cc_set_conf_start_tstamp: no confID set - confID:0

Sep 20 10:13:46.619: //204/xxxxxxxxxxxx/CCAPI/cc_api_call_connected:
   Call Entry(Connected=TRUE, Responsed=TRUE, Retry Count=0)
Sep 20 10:13:46.619: //204/xxxxxxxxxxxx/CCAPI/cc_api_call_connected:exit@5774
Sep 20 10:13:46.619: //204/xxxxxxxxxxxx/CCAPI/cc_incr_if_call_volume:
   Remote IP Address=0.0.0.0, Hwidb=GigabitEthernet0/1
Sep 20 10:13:46.619: //204/xxxxxxxxxxxx/CCAPI/cc_incr_if_call_volume:
   Total Call Count=2, Voip Call Count=2, MMoip Call Count=0
Sep 20 10:13:46.623: //203/xxxxxxxxxxxx/CCAPI/ccConferenceCreate:
   (confID=0x49F9BB80, callID1=0xCB, callID2=0xCA, tag=0x0)
Sep 20 10:13:46.623: //203/xxxxxxxxxxxx/CCAPI/ccConferenceCreate:
   (confID=0x49F9BB80, callID1=0xCB, gcid=0-0-0-0, tag=0x0)
Sep 20 10:13:46.623: //202/xxxxxxxxxxxx/CCAPI/ccConferenceCreate:
   (confID=0x49F9BB80, callID2=0xCA, gcid=0-0-0-0, tag=0x0)
Sep 20 10:13:46.623: //203/xxxxxxxxxxxx/CCAPI/ccConferenceCreate:
   Conference Id=0x49F9BB80, Call Id1=203, Call Id2=202, Tag=0x0
Sep 20 10:13:46.623: //203/xxxxxxxxxxxx/CCAPI/cc_api_bridge_done:
   Conference Id=0x87, Source Interface=0x48A57CE4, Source Call Id=203,
   Destination Call Id=202, Disposition=0x0, Tag=0x0
Sep 20 10:13:46.627: //202/xxxxxxxxxxxx/CCAPI/cc_api_bridge_done:
   Conference Id=0x87, Source Interface=0x4912D9FC, Source Call Id=202,
   Destination Call Id=203, Disposition=0x0, Tag=0x0
Sep 20 10:13:46.627: //203/xxxxxxxxxxxx/CCAPI/cc_generic_bridge_done:
   Conference Id=0x87, Source Interface=0x4912D9FC, Source Call Id=202,
   Destination Call Id=203, Disposition=0x0, Tag=0x0
Sep 20 10:13:46.627: //203/xxxxxxxxxxxx/CCAPI/ccConferenceCreate:
   Call Entry(Conference Id=0x87, Destination Call Id=202)
Sep 20 10:13:46.627: //202/xxxxxxxxxxxx/CCAPI/ccConferenceCreate:
   Call Entry(Conference Id=0x
londrtr1#87, Destination Call Id=203)
Sep 20 10:13:46.627: //203/xxxxxxxxxxxx/CCAPI/ccConferenceCreate:
   (confID=0x49F9BB80, callID1=0xCB, callID2=0xCC, tag=0x0)
Sep 20 10:13:46.627: //203/xxxxxxxxxxxx/CCAPI/ccConferenceCreate:
   (confID=0x49F9BB80, callID1=0xCB, gcid=0-0-0-0, tag=0x0)
Sep 20 10:13:46.627: //204/xxxxxxxxxxxx/CCAPI/ccConferenceCreate:
   (confID=0x49F9BB80, callID2=0xCC, gcid=0-0-0-0, tag=0x0)
Sep 20 10:13:46.627: //203/xxxxxxxxxxxx/CCAPI/ccConferenceCreate:
   Conference Id=0x49F9BB80, Call Id1=203, Call Id2=204, Tag=0x0
Sep 20 10:13:46.627: //204/xxxxxxxxxxxx/CCAPI/cc_api_bridge_done:
   Conference Id=0x88, Source Interface=0x4912D9FC, Source Call Id=204,
   Destination Call Id=203, Disposition=0x0, Tag=0x0
Sep 20 10:13:46.627: //203/xxxxxxxxxxxx/CCAPI/ccConferenceCreate:
   Call Entry(Conference Id=0x88, Destination Call Id=204)
Sep 20 10:13:46.627: //204/xxxxxxxxxxxx/CCAPI/ccConferenceCreate:
   Call Entry(Conference Id=0x88, Destination Call Id=203)
Sep 20 10:13:46.627: //202/xxxxxxxxxxxx/CCAPI/ccCallModify:
   Nominator=0x0, Params=0x49F9B660, Call Id=202
Sep 20 10:13:46.627: //203/xxxxxxxxxxxx/CCAPI/cc_process_notify_bridge_done:
   Conference Id=0x87, Call Id1=203, Call Id2=202
Sep 20 10:13:46.631: //203/xxxxxxxxxxxx/CCAPI/cc_api_bridge_done:
   Conference Id=0x88, Source Interface=0x48A57CE4, Source Call Id=203,
   Destination Call Id=204, Disposition=0x0, Tag=0x0
Sep 20 10:13:46.631: //203/xxxxxxxxxxxx/CCAPI/cc_generic_bridge_done:
   Conference Id=0x88, Source Interface=0x48A57CE4, Source Call Id=203,
   Destination Call Id=204, Disposition=0x0, Tag=0x0
Sep 20 10:13:46.631: //202/xxxxxxxxxxxx/CCAPI/cc_api_call_modify_done:
   Result=0, Interface=0x4912D9FC, Call Id=202
Sep 20 10:13:46.631: //203/xxxxxxxxxxxx/CCAPI/cc_process_notify_bridge_done:
   Conference Id=0x88, Call Id1=203, Call Id2=204
Sep 20 10:13:46.631: //204/xxxxxxxxxxxx/CCAPI/ccCallModify:
   Nominator=0x0, Params=0x49F9B660, Call Id=204
Sep 20 10:13:46.631: //202/xxxxxxxxxxxx/CCAPI/ccCallModifyExtended:
   Nominator=0x49F9BBB8, Params=0x49F9BB90, Call Id=202
Sep 20 10:13:46.635: //204/xxxxxxxxxxxx/CCAPI/cc_api_call_modify_done:
   Result=0, Interface=0x4912D9FC, Call Id=204
Sep 20 10:13:46.635: //204/xxxxxxxxxxxx/CCAPI/ccCallModify:
   Nominator=0x18E00, Params=0x49F9BE80, Call Id=204
Sep 20 10:13:46.635: //204/xxxxxxxxxxxx/CCAPI/cc_api_call_modify_done:
   Result=0, Interface=0x4912D9FC, Call Id=204
Sep 20 10:13:46.639: //204/xxxxxxxxxxxx/CCAPI/ccCallModifyExtended:
   Nominator=0x49F9BBB8, Params=0x49F9BB90, Call Id=204
Sep 20 10:13:46.639: //204/xxxxxxxxxxxx/CCAPI/ccCallModifyExtended:
   Nominator=0x49F9BBB8, Params=0x49F9BB90, Call Id=204
Sep 20 10:13:46.675: //203/xxxxxxxxxxxx/CCAPI/ccConferenceDestroy:
   Conference Id=0x87, Tag=0x0
Sep 20 10:13:46.675: //-1/xxxxxxxxxxxx/CCAPI/ccConferenceDestroy:
   CALL_ERROR_INFORMATIONAL; mute call detection failed with confID=0x87
Sep 20 10:13:46.675: //203/xxxxxxxxxxxx/CCAPI/cc_api_bridge_drop_done:
   Conference Id=0x87, Source Interface=0x48A57CE4, Source Call Id=203,
   Destination Call Id=202, Disposition=0x0, Tag=0x0
Sep 20 10:13:46.675: //202/xxxxxxxxxxxx/CCAPI/cc_api_bri
londrtr1#dge_drop_done:
   Conference Id=0x87, Source Interface=0x4912D9FC, Source Call Id=202,
   Destination Call Id=203, Disposition=0x0, Tag=0x0
Sep 20 10:13:46.675: //203/xxxxxxxxxxxx/CCAPI/cc_generic_bridge_done:
   Conference Id=0x87, Source Interface=0x4912D9FC, Source Call Id=202,
   Destination Call Id=203, Disposition=0x0, Tag=0x0
Sep 20 10:13:46.683: //204/xxxxxxxxxxxx/CCAPI/ccCallModify:
   Nominator=0x800, Params=0x49F9BEF8, Call Id=204
Sep 20 10:13:46.683: //204/xxxxxxxxxxxx/CCAPI/cc_api_call_modify_done:
   Result=0, Interface=0x4912D9FC, Call Id=204
Sep 20 10:13:46.683: //202/xxxxxxxxxxxx/CCAPI/ccCallDisconnect:
   Cause Value=0, Tag=0x0, Call Entry(Previous Disconnect Cause=0, Disconnect Ca
use=0)
Sep 20 10:13:46.687: //202/xxxxxxxxxxxx/CCAPI/ccCallDisconnect:
   Start Calling Accounting;
   Call Entry(Incoming=FALSE)
Sep 20 10:13:46.687: //202/xxxxxxxxxxxx/CCAPI/ccCallDisconnect:
   Cause Value=0, Call Entry(Disconnect Cause=0)
Sep 20 10:13:46.687: //202/xxxxxxxxxxxx/CCAPI/ccCallDisconnect:
   Cause Value=0, Call Entry(Responsed=TRUE, Cause Value=0)
Sep 20 10:13:46.687: //204/xxxxxxxxxxxx/CCAPI/ccCallModifyExtended:
   Nominator=0x49F9BBB8, Params=0x49F9BB90, Call Id=204
Sep 20 10:13:46.687: //203/xxxxxxxxxxxx/CCAPI/ccConferenceDestroy:
   Conference Id=0x88, Tag=0x0
Sep 20 10:13:46.687: //-1/xxxxxxxxxxxx/CCAPI/ccConferenceDestroy:
   CALL_ERROR_INFORMATIONAL; mute call detection failed with confID=0x88
Sep 20 10:13:46.687: //203/xxxxxxxxxxxx/CCAPI/cc_api_bridge_drop_done:
   Conference Id=0x88, Source Interface=0x48A57CE4, Source Call Id=203,
   Destination Call Id=204, Disposition=0x0, Tag=0x0
Sep 20 10:13:46.687: //204/xxxxxxxxxxxx/CCAPI/cc_api_bridge_drop_done:
   Conference Id=0x88, Source Interface=0x4912D9FC, Source Call Id=204,
   Destination Call Id=203, Disposition=0x0, Tag=0x0
Sep 20 10:13:46.687: //203/xxxxxxxxxxxx/CCAPI/cc_generic_bridge_done:
   Conference Id=0x88, Source Interface=0x4912D9FC, Source Call Id=204,
   Destination Call Id=203, Disposition=0x0, Tag=0x0
Sep 20 10:13:46.687: //-1/xxxxxxxxxxxx/CCAPI/cc_api_icpif:
   ExpectFactor=0xA
Sep 20 10:13:46.687: //202/xxxxxxxxxxxx/CCAPI/cc_decr_if_call_volume:
   Remote IP Address=0.0.0.0, Hwidb=GigabitEthernet0/1
Sep 20 10:13:46.687: //202/xxxxxxxxxxxx/CCAPI/cc_decr_if_call_volume:
   Total Call Count=1, Voip Call Count=1, MMoip Call Count=0
Sep 20 10:13:46.687: //202/xxxxxxxxxxxx/CCAPI/cc_api_call_disconnect_done:
   Disposition=0, Interface=0x4912D9FC, Tag=0x0, Call Id=202,
   Call Entry(Disconnect Cause=0, Voice Class Cause Code=0, Retry Count=0)
Sep 20 10:13:46.687: //202/xxxxxxxxxxxx/CCAPI/cc_api_call_disconnect_done:
   Call Disconnect Event Sent
Sep 20 10:13:46.687: //202/xxxxxxxxxxxx/CCAPI/cc_delete_guid_pod_entry:
   Incoming=FALSE
Sep 20 10:13:46.687: //-1/xxxxxxxxxxxx/CCAPI/cc_free_feature_vsa:

Sep 20 10:13:46.687: :cc_free_feature_vsa freeing 4B6B6B90
Sep 20 10:13:46.687: //-1/xxxxxxxxxxxx/CCAPI/cc_free_feature_vsa:

Sep 20 10:13:46.687:  vsacount in free is 2
Sep 20 10:13:46.687: //202/xxxxxxxxxxxx/CCAPI/cc_delete_call_entry:
   Total Call Count=0, Call Entry(Call Count On=FALSE, Incoming Call=FALSE)
Sep 20 10:13:46.695: //204/xxxxxxxxxxxx/CCAPI/ccCallDisconnect:
   Cause Value=0, Tag=0x0, Call Entry(Previous Disconnect Cause=0, Disconnect Ca
use=0)
Sep 20 10:13:46.695: //204/xxxxxxxxxxxx/CCAPI/ccCallDisconnect:
   Start Calling Accounting;
   Call Entry(Incoming=FALSE)
Sep 20 10:13:46.695: //204/xxxxxxxxxxxx/CCAPI/ccCallDisconnect:
   Cause Value=0, Call Entry(Disconnect Cause=0)
Sep 20 10:13:46.695: //204/xxxxxxxxxxxx/CCAPI/ccCallDisconnect:
   Cause Value=0, Call Entry(Responsed=TRUE, Cause Value=0)
Sep 20 10:13:46.699: //-1
londrtr1#/xxxxxxxxxxxx/CCAPI/cc_api_icpif:
   ExpectFactor=0xA
Sep 20 10:13:46.699: //204/xxxxxxxxxxxx/CCAPI/cc_decr_if_call_volume:
   Remote IP Address=0.0.0.0, Hwidb=GigabitEthernet0/1
Sep 20 10:13:46.699: //204/xxxxxxxxxxxx/CCAPI/cc_decr_if_call_volume:
   Total Call Count=0, Voip Call Count=0, MMoip Call Count=0
Sep 20 10:13:46.699: //204/xxxxxxxxxxxx/CCAPI/cc_api_call_disconnect_done:
   Disposition=0, Interface=0x4912D9FC, Tag=0x0, Call Id=204,
   Call Entry(Disconnect Cause=0, Voice Class Cause Code=0, Retry Count=0)
Sep 20 10:13:46.699: //204/xxxxxxxxxxxx/CCAPI/cc_api_call_disconnect_done:
   Call Disconnect Event Sent
Sep 20 10:13:46.699: //204/xxxxxxxxxxxx/CCAPI/cc_delete_guid_pod_entry:
   Incoming=FALSE
Sep 20 10:13:46.699: //-1/xxxxxxxxxxxx/CCAPI/cc_free_feature_vsa:

Sep 20 10:13:46.699: :cc_free_feature_vsa freeing 4B6B69D0
Sep 20 10:13:46.699: //-1/xxxxxxxxxxxx/CCAPI/cc_free_feature_vsa:

Sep 20 10:13:46.699:  vsacount in free is 1
Sep 20 10:13:46.699: //204/xxxxxxxxxxxx/CCAPI/cc_delete_call_entry:
   Total Call Count=0, Call Entry(Call Count On=FALSE, Incoming Call=FALSE)
Sep 20 10:13:46.707: //203/xxxxxxxxxxxx/CCAPI/ccCallDisconnect:
   Cause Value=0, Tag=0x0, Call Entry(Previous Disconnect Cause=0, Disconnect Ca
use=0)
Sep 20 10:13:46.707: //203/xxxxxxxxxxxx/CCAPI/ccCallDisconnect:
   Start Calling Accounting;
   Call Entry(Incoming=FALSE)
Sep 20 10:13:46.707: //203/xxxxxxxxxxxx/CCAPI/ccCallDisconnect:
   Cause Value=0, Call Entry(Disconnect Cause=0)
Sep 20 10:13:46.707: //203/xxxxxxxxxxxx/CCAPI/ccCallDisconnect:
   Cause Value=0, Call Entry(Responsed=TRUE, Cause Value=0)
Sep 20 10:13:46.707: //203/xxxxxxxxxxxx/CCAPI/cc_api_call_disconnect_done:
   Disposition=0, Interface=0x48A57CE4, Tag=0x0, Call Id=203,
   Call Entry(Disconnect Cause=0, Voice Class Cause Code=0, Retry Count=0)
Sep 20 10:13:46.707: //203/xxxxxxxxxxxx/CCAPI/cc_api_call_disconnect_done:
   Call Disconnect Event Sent
Sep 20 10:13:46.707: //203/xxxxxxxxxxxx/CCAPI/cc_delete_guid_pod_entry:
   Incoming=FALSE
Sep 20 10:13:46.707: //-1/xxxxxxxxxxxx/CCAPI/cc_free_feature_vsa:

Sep 20 10:13:46.707: :cc_free_feature_vsa freeing 4B6B6AB0
Sep 20 10:13:46.707: //-1/xxxxxxxxxxxx/CCAPI/cc_free_feature_vsa:

Sep 20 10:13:46.707:  vsacount in free is 0
Sep 20 10:13:46.707: //203/xxxxxxxxxxxx/CCAPI/cc_delete_call_entry:
   Total Call Count=0, Call Entry(Call Count On=FALSE, Incoming Call=FALSE)
londrtr1#

sccp ccm group 1
 bind interface GigabitEthernet0/0
 associate ccm 1 priority 1
 associate ccm 2 priority 2
 associate ccm 3 priority 3
 associate profile 1 register MTP00260b53a340
 associate profile 2 register CFB00260b53a340
!
dspfarm profile 1 transcode
 codec g711ulaw
 codec g711alaw
 codec g729ar8
 codec g729abr8
 codec g729r8
 maximum sessions 12
 associate application SCCP
!
dspfarm profile 2 conference
 codec g711ulaw
 codec g711alaw
 codec g729ar8
 codec g729abr8
 codec g729r8
 codec g729br8
 maximum sessions 4
 associate application SCCP