Skip to content

Instantly share code, notes, and snippets.

@bklang
Created September 9, 2014 16:49
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 bklang/c92951daac5bfa22db4f to your computer and use it in GitHub Desktop.
Save bklang/c92951daac5bfa22db4f to your computer and use it in GitHub Desktop.
[2014-09-09 09:47:26.021] DEBUG Adhearsion::Call: f687135e-bd40-4063-9460-3a13587e057c@: Account: #<Account @values={:id=>1, :name=>"League of Extraordinary Doctors", :welcome_message=>nil, :opens_at=>nil, :closes_at=>nil, :welcome_audio=>nil, :backup_number=>"8056182382", :street=>"510 State St Suite 220", :city=>"Santa Barbara", :zip=>"93105", :phone=>"7604733993", :contact=>"Andrew Cox", :email=>"owner@domain.com", :created_at=>2014-09-09 06:29:34 -0700, :updated_at=>2014-09-09 06:29:34 -0700, :unit_number=>nil, :state_id=>5, :area_code_id=>177, :category_mode=>nil, :owner_id=>1}>
[2014-09-09 09:47:26.021] ERROR Adhearsion::Call: f687135e-bd40-4063-9460-3a13587e057c@: <RuntimeError> Help?
/mnt/hgfs/ringrx/oncall-telephony/app/controllers/authentication_controller.rb:13:in `run'
/home/bklang/.rvm/gems/ruby-2.1.2@audible_rx/bundler/gems/adhearsion-4b2f7f7960bd/lib/adhearsion/call_controller.rb:146:in `invoke'
/mnt/hgfs/ringrx/oncall-telephony/app/controllers/account_management_controller.rb:41:in `authenticate_user'
/mnt/hgfs/ringrx/oncall-telephony/app/controllers/account_management_controller.rb:18:in `run'
/home/bklang/.rvm/gems/ruby-2.1.2@audible_rx/bundler/gems/adhearsion-4b2f7f7960bd/lib/adhearsion/call_controller.rb:119:in `execute!'
/home/bklang/.rvm/gems/ruby-2.1.2@audible_rx/bundler/gems/adhearsion-4b2f7f7960bd/lib/adhearsion/call_controller.rb:94:in `block in exec'
/home/bklang/.rvm/gems/ruby-2.1.2@audible_rx/bundler/gems/adhearsion-4b2f7f7960bd/lib/adhearsion/call_controller.rb:93:in `catch'
/home/bklang/.rvm/gems/ruby-2.1.2@audible_rx/bundler/gems/adhearsion-4b2f7f7960bd/lib/adhearsion/call_controller.rb:93:in `exec'
/home/bklang/.rvm/gems/ruby-2.1.2@audible_rx/bundler/gems/adhearsion-4b2f7f7960bd/lib/adhearsion/call_controller.rb:98:in `exec'
/home/bklang/.rvm/gems/ruby-2.1.2@audible_rx/bundler/gems/adhearsion-4b2f7f7960bd/lib/adhearsion/call_controller.rb:110:in `exec_with_callback'
/home/bklang/.rvm/gems/ruby-2.1.2@audible_rx/bundler/gems/adhearsion-4b2f7f7960bd/lib/adhearsion/call_controller.rb:104:in `block (2 levels) in bg_exec'
/home/bklang/.rvm/gems/ruby-2.1.2@audible_rx/bundler/gems/adhearsion-4b2f7f7960bd/lib/adhearsion/foundation/exception_handler.rb:5:in `catching_standard_errors'
/home/bklang/.rvm/gems/ruby-2.1.2@audible_rx/bundler/gems/adhearsion-4b2f7f7960bd/lib/adhearsion/call_controller.rb:103:in `block in bg_exec'
/home/bklang/.rvm/gems/ruby-2.1.2@audible_rx/gems/celluloid-0.15.2/lib/celluloid/thread_handle.rb:13:in `block in initialize'
/home/bklang/.rvm/gems/ruby-2.1.2@audible_rx/gems/celluloid-0.15.2/lib/celluloid/internal_pool.rb:100:in `call'
/home/bklang/.rvm/gems/ruby-2.1.2@audible_rx/gems/celluloid-0.15.2/lib/celluloid/internal_pool.rb:100:in `block in create'
/home/bklang/.rvm/gems/ruby-2.1.2@audible_rx/gems/logging-1.8.2/lib/logging/diagnostic_context.rb:323:in `call'
/home/bklang/.rvm/gems/ruby-2.1.2@audible_rx/gems/logging-1.8.2/lib/logging/diagnostic_context.rb:323:in `block in create_with_logging_context'
[2014-09-09 09:47:26.022] DEBUG Adhearsion::Call: f687135e-bd40-4063-9460-3a13587e057c@: Finished executing controller #<AccountManagementController call=f687135e-bd40-4063-9460-3a13587e057c, metadata={:from_inbound=>"+18053221170"}>
[2014-09-09 09:47:26.026] INFO Adhearsion::Router::Route: Call f687135e-bd40-4063-9460-3a13587e057c routing completed. Hanging up now.
[2014-09-09 09:47:26.026] INFO Adhearsion::Call: f687135e-bd40-4063-9460-3a13587e057c@: Hanging up
[2014-09-09 09:47:26.027] DEBUG Adhearsion::Call: f687135e-bd40-4063-9460-3a13587e057c@: Executing command #<Punchblock::Command::Hangup target_call_id=nil, target_mixer_name=nil, component_id=nil, source_uri=nil, domain=nil, transport=nil, timestamp=Tue, 09 Sep 2014 09:47:26 -0700, request_id="4e9008d3-0e19-4be7-8d31-56188e0983c6", headers={}>
[2014-09-09 09:47:26.028] TRACE Punchblock::Connection::Asterisk: [SEND] Action: hangup
ActionID: ad31f5ca-d2e5-4912-915b-2a02672b22f0
Channel: SIP/usera-00000022
Cause: 16
[2014-09-09 09:47:26.030] TRACE Punchblock::Connection::Asterisk: [RECV] Response: Success
ActionID: ad31f5ca-d2e5-4912-915b-2a02672b22f0
Message: Channel Hungup
Event: AsyncAGI
Privilege: agi,all
SubEvent: End
Channel: SIP/usera-00000022
Event: VarSet
Privilege: dialplan,all
Channel: SIP/usera-00000022
Variable: AGISTATUS
Value: HANGUP
Uniqueid: 1410281244.34
Event: SoftHangupRequest
Privilege: call,all
Channel: SIP/usera-00000022
Uniqueid: 1410281244.34
Cause: 16
Event: VarSet
Privilege: dialplan,all
Channel: SIP/usera-00000022
Variable: RTPAUDIOQOS
Value: ssrc=2126491959;themssrc=901322238;lp=0;rxjitter=0.000000;rxcount=79;txjitter=0.004714;txcount=66;rlp=0;rtt=0.000000
Uniqueid: 1410281244.34
Event: VarSet
Privilege: dialplan,all
Channel: SIP/usera-00000022
Variable: RTPAUDIOQOSJITTER
Value: minrxjitter=0.000000;maxrxjitter=0.000000;avgrxjitter=0.000000;stdevrxjitter=0.000000;reported_minjitter=0.000000;reported_maxjitter=0.000000;reported_avgjitter=0.000000;reported_stdevjitter=0.000000;
Uniqueid: 1410281244.34
Event: VarSet
Privilege: dialplan,all
Channel: SIP/usera-00000022
Variable: RTPAUDIOQOSLOSS
Value: minrxlost=0.000000;maxrxlost=0.000000;avgrxlost=0.000000;stdevrxlost=0.000000;reported_minlost=0.000000;reported_maxlost=0.000000;reported_avglost=0.000000;reported_stdevlost=0.000000;
Uniqueid: 1410281244.34
Event: VarSet
Privilege: dialplan,all
Channel: SIP/usera-00000022
Variable: RTPAUDIOQOSRTT
Value: minrtt=0.000000;maxrtt=0.000000;avgrtt=0.000000;stdevrtt=0.000000;
Uniqueid: 1410281244.34
Event: VarSet
Privilege: dialplan,all
Channel: SIP/usera-00000022
Variable: RTPAUDIOQOS
Value: ssrc=2126491959;themssrc=901322238;lp=0;rxjitter=0.000000;rxcount=79;txjitter=0.004714;txcount=66;rlp=0;rtt=0.000000
Uniqueid: 1410281244.34
Event: Hangup
Privilege: call,all
Channel: SIP/usera-00000022
Uniqueid: 1410281244.34
CallerIDNum: usera
CallerIDName: RRX Fusion A
ConnectedLineNum: <unknown>
ConnectedLineName: <unknown>
AccountCode:
Cause: 16
Cause-txt: Normal Clearing
[2014-09-09 09:47:26.030] TRACE Punchblock::Connection::Asterisk: [RECV] #<RubyAMI::Response headers={"ActionID"=>"ad31f5ca-d2e5-4912-915b-2a02672b22f0", "Message"=>"Channel Hungup"}, text_body=nil, events=[]>
[2014-09-09 09:47:26.031] TRACE Punchblock::Connection::Asterisk: [RECV] #<RubyAMI::Event name="AsyncAGI", headers={"Privilege"=>"agi,all", "SubEvent"=>"End", "Channel"=>"SIP/usera-00000022"}, text_body=nil, events=[]>
[2014-09-09 09:47:26.031] TRACE Punchblock::Connection::Asterisk: [RECV] #<RubyAMI::Event name="VarSet", headers={"Privilege"=>"dialplan,all", "Channel"=>"SIP/usera-00000022", "Variable"=>"AGISTATUS", "Value"=>"HANGUP", "Uniqueid"=>"1410281244.34"}, text_body=nil, events=[]>
[2014-09-09 09:47:26.032] TRACE Punchblock::Connection::Asterisk: [RECV] #<RubyAMI::Event name="SoftHangupRequest", headers={"Privilege"=>"call,all", "Channel"=>"SIP/usera-00000022", "Uniqueid"=>"1410281244.34", "Cause"=>"16"}, text_body=nil, events=[]>
[2014-09-09 09:47:26.032] TRACE Punchblock::Connection::Asterisk: [RECV] #<RubyAMI::Event name="VarSet", headers={"Privilege"=>"dialplan,all", "Channel"=>"SIP/usera-00000022", "Variable"=>"RTPAUDIOQOS", "Value"=>"ssrc=2126491959;themssrc=901322238;lp=0;rxjitter=0.000000;rxcount=79;txjitter=0.004714;txcount=66;rlp=0;rtt=0.000000", "Uniqueid"=>"1410281244.34"}, text_body=nil, events=[]>
[2014-09-09 09:47:26.032] TRACE Punchblock::Connection::Asterisk: [RECV] #<RubyAMI::Event name="VarSet", headers={"Privilege"=>"dialplan,all", "Channel"=>"SIP/usera-00000022", "Variable"=>"RTPAUDIOQOSJITTER", "Value"=>"minrxjitter=0.000000;maxrxjitter=0.000000;avgrxjitter=0.000000;stdevrxjitter=0.000000;reported_minjitter=0.000000;reported_maxjitter=0.000000;reported_avgjitter=0.000000;reported_stdevjitter=0.000000;", "Uniqueid"=>"1410281244.34"}, text_body=nil, events=[]>
[2014-09-09 09:47:26.032] TRACE Punchblock::Connection::Asterisk: [RECV] #<RubyAMI::Event name="VarSet", headers={"Privilege"=>"dialplan,all", "Channel"=>"SIP/usera-00000022", "Variable"=>"RTPAUDIOQOSLOSS", "Value"=>"minrxlost=0.000000;maxrxlost=0.000000;avgrxlost=0.000000;stdevrxlost=0.000000;reported_minlost=0.000000;reported_maxlost=0.000000;reported_avglost=0.000000;reported_stdevlost=0.000000;", "Uniqueid"=>"1410281244.34"}, text_body=nil, events=[]>
[2014-09-09 09:47:26.033] TRACE Punchblock::Connection::Asterisk: [RECV] #<RubyAMI::Event name="VarSet", headers={"Privilege"=>"dialplan,all", "Channel"=>"SIP/usera-00000022", "Variable"=>"RTPAUDIOQOSRTT", "Value"=>"minrtt=0.000000;maxrtt=0.000000;avgrtt=0.000000;stdevrtt=0.000000;", "Uniqueid"=>"1410281244.34"}, text_body=nil, events=[]>
[2014-09-09 09:47:26.033] TRACE Punchblock::Connection::Asterisk: [RECV] #<RubyAMI::Event name="VarSet", headers={"Privilege"=>"dialplan,all", "Channel"=>"SIP/usera-00000022", "Variable"=>"RTPAUDIOQOS", "Value"=>"ssrc=2126491959;themssrc=901322238;lp=0;rxjitter=0.000000;rxcount=79;txjitter=0.004714;txcount=66;rlp=0;rtt=0.000000", "Uniqueid"=>"1410281244.34"}, text_body=nil, events=[]>
[2014-09-09 09:47:26.033] TRACE Punchblock::Connection::Asterisk: [RECV] #<RubyAMI::Event name="Hangup", headers={"Privilege"=>"call,all", "Channel"=>"SIP/usera-00000022", "Uniqueid"=>"1410281244.34", "CallerIDNum"=>"usera", "CallerIDName"=>"RRX Fusion A", "ConnectedLineNum"=>"<unknown>", "ConnectedLineName"=>"<unknown>", "AccountCode"=>"", "Cause"=>"16", "Cause-txt"=>"Normal Clearing"}, text_body=nil, events=[]>
[2014-09-09 09:47:26.036] DEBUG Adhearsion::Call: f687135e-bd40-4063-9460-3a13587e057c@: Receiving message: #<Punchblock::Event::Asterisk::AMI::Event target_call_id="f687135e-bd40-4063-9460-3a13587e057c", target_mixer_name=nil, component_id=nil, source_uri=nil, domain=nil, transport=nil, timestamp=Tue, 09 Sep 2014 09:47:26 -0700, name="AsyncAGI", headers={"Privilege"=>"agi,all", "SubEvent"=>"End", "Channel"=>"SIP/usera-00000022"}>
[2014-09-09 09:47:26.037] DEBUG Adhearsion::Call: f687135e-bd40-4063-9460-3a13587e057c@: Receiving message: #<Punchblock::Event::Asterisk::AMI::Event target_call_id="f687135e-bd40-4063-9460-3a13587e057c", target_mixer_name=nil, component_id=nil, source_uri=nil, domain=nil, transport=nil, timestamp=Tue, 09 Sep 2014 09:47:26 -0700, name="VarSet", headers={"Privilege"=>"dialplan,all", "Channel"=>"SIP/usera-00000022", "Variable"=>"AGISTATUS", "Value"=>"HANGUP", "Uniqueid"=>"1410281244.34"}>
[2014-09-09 09:47:26.038] DEBUG Adhearsion::Call: f687135e-bd40-4063-9460-3a13587e057c@: Receiving message: #<Punchblock::Event::Asterisk::AMI::Event target_call_id="f687135e-bd40-4063-9460-3a13587e057c", target_mixer_name=nil, component_id=nil, source_uri=nil, domain=nil, transport=nil, timestamp=Tue, 09 Sep 2014 09:47:26 -0700, name="SoftHangupRequest", headers={"Privilege"=>"call,all", "Channel"=>"SIP/usera-00000022", "Uniqueid"=>"1410281244.34", "Cause"=>"16"}>
[2014-09-09 09:47:26.038] DEBUG Adhearsion::Call: f687135e-bd40-4063-9460-3a13587e057c@: Receiving message: #<Punchblock::Event::Asterisk::AMI::Event target_call_id="f687135e-bd40-4063-9460-3a13587e057c", target_mixer_name=nil, component_id=nil, source_uri=nil, domain=nil, transport=nil, timestamp=Tue, 09 Sep 2014 09:47:26 -0700, name="VarSet", headers={"Privilege"=>"dialplan,all", "Channel"=>"SIP/usera-00000022", "Variable"=>"RTPAUDIOQOSJITTER", "Value"=>"minrxjitter=0.000000;maxrxjitter=0.000000;avgrxjitter=0.000000;stdevrxjitter=0.000000;reported_minjitter=0.000000;reported_maxjitter=0.000000;reported_avgjitter=0.000000;reported_stdevjitter=0.000000;", "Uniqueid"=>"1410281244.34"}>
[2014-09-09 09:47:26.038] DEBUG Adhearsion::Call: f687135e-bd40-4063-9460-3a13587e057c@: Receiving message: #<Punchblock::Event::Asterisk::AMI::Event target_call_id="f687135e-bd40-4063-9460-3a13587e057c", target_mixer_name=nil, component_id=nil, source_uri=nil, domain=nil, transport=nil, timestamp=Tue, 09 Sep 2014 09:47:26 -0700, name="VarSet", headers={"Privilege"=>"dialplan,all", "Channel"=>"SIP/usera-00000022", "Variable"=>"RTPAUDIOQOS", "Value"=>"ssrc=2126491959;themssrc=901322238;lp=0;rxjitter=0.000000;rxcount=79;txjitter=0.004714;txcount=66;rlp=0;rtt=0.000000", "Uniqueid"=>"1410281244.34"}>
[2014-09-09 09:47:26.039] DEBUG Adhearsion::Call: f687135e-bd40-4063-9460-3a13587e057c@: Receiving message: #<Punchblock::Event::Asterisk::AMI::Event target_call_id="f687135e-bd40-4063-9460-3a13587e057c", target_mixer_name=nil, component_id=nil, source_uri=nil, domain=nil, transport=nil, timestamp=Tue, 09 Sep 2014 09:47:26 -0700, name="VarSet", headers={"Privilege"=>"dialplan,all", "Channel"=>"SIP/usera-00000022", "Variable"=>"RTPAUDIOQOSRTT", "Value"=>"minrtt=0.000000;maxrtt=0.000000;avgrtt=0.000000;stdevrtt=0.000000;", "Uniqueid"=>"1410281244.34"}>
[2014-09-09 09:47:26.039] DEBUG Adhearsion::Call: f687135e-bd40-4063-9460-3a13587e057c@: Receiving message: #<Punchblock::Event::Asterisk::AMI::Event target_call_id="f687135e-bd40-4063-9460-3a13587e057c", target_mixer_name=nil, component_id=nil, source_uri=nil, domain=nil, transport=nil, timestamp=Tue, 09 Sep 2014 09:47:26 -0700, name="VarSet", headers={"Privilege"=>"dialplan,all", "Channel"=>"SIP/usera-00000022", "Variable"=>"RTPAUDIOQOSLOSS", "Value"=>"minrxlost=0.000000;maxrxlost=0.000000;avgrxlost=0.000000;stdevrxlost=0.000000;reported_minlost=0.000000;reported_maxlost=0.000000;reported_avglost=0.000000;reported_stdevlost=0.000000;", "Uniqueid"=>"1410281244.34"}>
[2014-09-09 09:47:26.039] DEBUG Adhearsion::Call: f687135e-bd40-4063-9460-3a13587e057c@: Receiving message: #<Punchblock::Event::Asterisk::AMI::Event target_call_id="f687135e-bd40-4063-9460-3a13587e057c", target_mixer_name=nil, component_id=nil, source_uri=nil, domain=nil, transport=nil, timestamp=Tue, 09 Sep 2014 09:47:26 -0700, name="VarSet", headers={"Privilege"=>"dialplan,all", "Channel"=>"SIP/usera-00000022", "Variable"=>"RTPAUDIOQOS", "Value"=>"ssrc=2126491959;themssrc=901322238;lp=0;rxjitter=0.000000;rxcount=79;txjitter=0.004714;txcount=66;rlp=0;rtt=0.000000", "Uniqueid"=>"1410281244.34"}>
[2014-09-09 09:47:26.040] DEBUG Adhearsion::Call: f687135e-bd40-4063-9460-3a13587e057c@: Receiving message: #<Punchblock::Event::Asterisk::AMI::Event target_call_id="f687135e-bd40-4063-9460-3a13587e057c", target_mixer_name=nil, component_id=nil, source_uri=nil, domain=nil, transport=nil, timestamp=Tue, 09 Sep 2014 09:47:26 -0700, name="Hangup", headers={"Privilege"=>"call,all", "Channel"=>"SIP/usera-00000022", "Uniqueid"=>"1410281244.34", "CallerIDNum"=>"usera", "CallerIDName"=>"RRX Fusion A", "ConnectedLineNum"=>"<unknown>", "ConnectedLineName"=>"<unknown>", "AccountCode"=>"", "Cause"=>"16", "Cause-txt"=>"Normal Clearing"}>
[2014-09-09 09:47:26.040] DEBUG Adhearsion::Call: f687135e-bd40-4063-9460-3a13587e057c@: Receiving message: #<Punchblock::Event::End target_call_id="f687135e-bd40-4063-9460-3a13587e057c", target_mixer_name=nil, component_id=nil, source_uri=nil, domain=nil, transport=nil, timestamp=Tue, 09 Sep 2014 09:47:26 -0700, headers={}, reason=:hangup_command, platform_code="16">
[2014-09-09 09:47:26.040] INFO Adhearsion::Call: f687135e-bd40-4063-9460-3a13587e057c@: Call ended due to hangup_command
[2014-09-09 09:47:26.041] ERROR Adhearsion::Call: f687135e-bd40-4063-9460-3a13587e057c@: <RuntimeError> Help?
/mnt/hgfs/ringrx/oncall-telephony/app/controllers/authentication_controller.rb:13:in `run'
/home/bklang/.rvm/gems/ruby-2.1.2@audible_rx/bundler/gems/adhearsion-4b2f7f7960bd/lib/adhearsion/call_controller.rb:146:in `invoke'
/mnt/hgfs/ringrx/oncall-telephony/app/controllers/account_management_controller.rb:41:in `authenticate_user'
/mnt/hgfs/ringrx/oncall-telephony/app/controllers/account_management_controller.rb:18:in `run'
/home/bklang/.rvm/gems/ruby-2.1.2@audible_rx/bundler/gems/adhearsion-4b2f7f7960bd/lib/adhearsion/call_controller.rb:119:in `execute!'
/home/bklang/.rvm/gems/ruby-2.1.2@audible_rx/bundler/gems/adhearsion-4b2f7f7960bd/lib/adhearsion/call_controller.rb:94:in `block in exec'
/home/bklang/.rvm/gems/ruby-2.1.2@audible_rx/bundler/gems/adhearsion-4b2f7f7960bd/lib/adhearsion/call_controller.rb:93:in `catch'
/home/bklang/.rvm/gems/ruby-2.1.2@audible_rx/bundler/gems/adhearsion-4b2f7f7960bd/lib/adhearsion/call_controller.rb:93:in `exec'
/home/bklang/.rvm/gems/ruby-2.1.2@audible_rx/bundler/gems/adhearsion-4b2f7f7960bd/lib/adhearsion/call_controller.rb:98:in `exec'
/home/bklang/.rvm/gems/ruby-2.1.2@audible_rx/bundler/gems/adhearsion-4b2f7f7960bd/lib/adhearsion/call_controller.rb:110:in `exec_with_callback'
/home/bklang/.rvm/gems/ruby-2.1.2@audible_rx/bundler/gems/adhearsion-4b2f7f7960bd/lib/adhearsion/call_controller.rb:104:in `block (2 levels) in bg_exec'
/home/bklang/.rvm/gems/ruby-2.1.2@audible_rx/bundler/gems/adhearsion-4b2f7f7960bd/lib/adhearsion/foundation/exception_handler.rb:5:in `catching_standard_errors'
/home/bklang/.rvm/gems/ruby-2.1.2@audible_rx/bundler/gems/adhearsion-4b2f7f7960bd/lib/adhearsion/call_controller.rb:103:in `block in bg_exec'
/home/bklang/.rvm/gems/ruby-2.1.2@audible_rx/gems/celluloid-0.15.2/lib/celluloid/thread_handle.rb:13:in `block in initialize'
/home/bklang/.rvm/gems/ruby-2.1.2@audible_rx/gems/celluloid-0.15.2/lib/celluloid/internal_pool.rb:100:in `call'
/home/bklang/.rvm/gems/ruby-2.1.2@audible_rx/gems/celluloid-0.15.2/lib/celluloid/internal_pool.rb:100:in `block in create'
/home/bklang/.rvm/gems/ruby-2.1.2@audible_rx/gems/logging-1.8.2/lib/logging/diagnostic_context.rb:323:in `call'
/home/bklang/.rvm/gems/ruby-2.1.2@audible_rx/gems/logging-1.8.2/lib/logging/diagnostic_context.rb:323:in `block in create_with_logging_context'
Sign up for free to join this conversation on GitHub. Already have an account? Sign in to comment