-- Executing VoiceMailMain("SIP/sip502-081abf60", "") in new stack
Jun 26 13:38:33 DEBUG[3919]: channel.c:1774 ast_settimeout: Scheduling timer at 160 sample intervals
    -- Playing 'vm-login' (language 'es')
Jun 26 13:38:33 DEBUG[2269]: chan_sip.c:1415 __sip_ack: Stopping retransmission on 'a0e11ec5-ef26f690@192.168.5.12' of Response 102: Match Found
Jun 26 13:38:35 DEBUG[3919]: channel.c:1774 ast_settimeout: Scheduling timer at 0 sample intervals
Jun 26 13:38:35 DEBUG[3919]: channel.c:1774 ast_settimeout: Scheduling timer at 0 sample intervals
Jun 26 13:38:40 DEBUG[3919]: channel.c:1774 ast_settimeout: Scheduling timer at 160 sample intervals
    -- Playing 'vm-password' (language 'es')
Jun 26 13:38:41 DEBUG[3919]: channel.c:1774 ast_settimeout: Scheduling timer at 0 sample intervals
Jun 26 13:38:41 DEBUG[3919]: channel.c:1774 ast_settimeout: Scheduling timer at 0 sample intervals
    -- Incorrect password '5500' for user '500' (context = default)
Jun 26 13:38:44 DEBUG[3919]: channel.c:1774 ast_settimeout: Scheduling timer at 160 sample intervals
    -- Playing 'vm-incorrect-mailbox' (language 'es')
Jun 26 13:38:46 DEBUG[3919]: channel.c:1774 ast_settimeout: Scheduling timer at 37 sample intervals
Jun 26 13:38:46 DEBUG[3919]: channel.c:1774 ast_settimeout: Scheduling timer at 0 sample intervals
Jun 26 13:38:46 DEBUG[3919]: channel.c:1774 ast_settimeout: Scheduling timer at 0 sample intervals
Jun 26 13:38:49 DEBUG[3919]: channel.c:1774 ast_settimeout: Scheduling timer at 160 sample intervals
    -- Playing 'vm-password' (language 'es')
Jun 26 13:38:50 DEBUG[3919]: channel.c:1774 ast_settimeout: Scheduling timer at 0 sample intervals
Jun 26 13:38:50 DEBUG[3919]: channel.c:1774 ast_settimeout: Scheduling timer at 0 sample intervals
Jun 26 13:38:51 DEBUG[3919]: app.c:1235 ast_lock_path: Locked path '/var/spool/asterisk/voicemail/default/500/Old'
Jun 26 13:38:51 DEBUG[3919]: app.c:1256 ast_unlock_path: Unlocked path '/var/spool/asterisk/voicemail/default/500/Old'
Jun 26 13:38:51 DEBUG[3919]: app.c:1235 ast_lock_path: Locked path '/var/spool/asterisk/voicemail/default/500/Old'
Jun 26 13:38:51 DEBUG[3919]: app.c:1256 ast_unlock_path: Unlocked path '/var/spool/asterisk/voicemail/default/500/Old'
Jun 26 13:38:51 DEBUG[3919]: app.c:1235 ast_lock_path: Locked path '/var/spool/asterisk/voicemail/default/500/INBOX'
Jun 26 13:38:51 DEBUG[3919]: app.c:1256 ast_unlock_path: Unlocked path '/var/spool/asterisk/voicemail/default/500/INBOX'
Jun 26 13:38:51 DEBUG[3919]: app.c:1235 ast_lock_path: Locked path '/var/spool/asterisk/voicemail/default/500/INBOX'
Jun 26 13:38:51 DEBUG[3919]: app.c:1256 ast_unlock_path: Unlocked path '/var/spool/asterisk/voicemail/default/500/INBOX'
Jun 26 13:38:51 WARNING[3919]: file.c:517 ast_openstream_full: File vm-youhaveno does not exist in any format
Jun 26 13:38:51 WARNING[3919]: file.c:829 ast_streamfile: Unable to open vm-youhaveno (format ulaw): No such file or directory
  == Spawn extension (oficina, 8500, 2) exited non-zero on 'SIP/sip502-081abf60'
Jun 26 13:38:51 DEBUG[3919]: pbx.c:1542 pbx_substitute_variables_helper_full: Function result is '"Carlos Urbieta" <502>'
Jun 26 13:38:51 DEBUG[3919]: pbx.c:1542 pbx_substitute_variables_helper_full: Function result is '502'
Jun 26 13:38:51 DEBUG[3919]: pbx.c:1542 pbx_substitute_variables_helper_full: Function result is '8500'
Jun 26 13:38:51 DEBUG[3919]: pbx.c:1542 pbx_substitute_variables_helper_full: Function result is 'oficina'
Jun 26 13:38:51 DEBUG[3919]: pbx.c:1542 pbx_substitute_variables_helper_full: Function result is 'SIP/sip502-081abf60'
Jun 26 13:38:51 DEBUG[3919]: pbx.c:1542 pbx_substitute_variables_helper_full: Function result is '(null)'
Jun 26 13:38:51 DEBUG[3919]: pbx.c:1542 pbx_substitute_variables_helper_full: Function result is 'VoiceMailMain'
Jun 26 13:38:51 DEBUG[3919]: pbx.c:1542 pbx_substitute_variables_helper_full: Function result is '(null)'
Jun 26 13:38:51 DEBUG[3919]: pbx.c:1542 pbx_substitute_variables_helper_full: Function result is '2007-06-26 13:38:33'
Jun 26 13:38:51 DEBUG[3919]: pbx.c:1542 pbx_substitute_variables_helper_full: Function result is '2007-06-26 13:38:33'
Jun 26 13:38:51 DEBUG[3919]: pbx.c:1542 pbx_substitute_variables_helper_full: Function result is '2007-06-26 13:38:51'
Jun 26 13:38:51 DEBUG[3919]: pbx.c:1542 pbx_substitute_variables_helper_full: Function result is '18'
Jun 26 13:38:51 DEBUG[3919]: pbx.c:1542 pbx_substitute_variables_helper_full: Function result is '18'
Jun 26 13:38:51 DEBUG[3919]: pbx.c:1542 pbx_substitute_variables_helper_full: Function result is 'ANSWERED'
Jun 26 13:38:51 DEBUG[3919]: pbx.c:1542 pbx_substitute_variables_helper_full: Function result is 'DOCUMENTATION'
Jun 26 13:38:51 DEBUG[3919]: pbx.c:1542 pbx_substitute_variables_helper_full: Function result is '(null)'
Jun 26 13:38:51 DEBUG[3919]: pbx.c:1542 pbx_substitute_variables_helper_full: Function result is '1182883113.54'
Jun 26 13:38:51 DEBUG[3919]: pbx.c:1542 pbx_substitute_variables_helper_full: Function result is '(null)'
Jun 26 13:38:51 DEBUG[3919]: chan_sip.c:2448 sip_hangup: update_call_counter(sip502) - decrement call limit counter
Jun 26 13:38:51 DEBUG[2269]: chan_sip.c:1415 __sip_ack: Stopping retransmission on 'a0e11ec5-ef26f690@192.168.5.12' of Request 102: Match Found
asterisk*CLI> 
asterisk:/etc/asterisk# pwd
/etc/asterisk
asterisk:/etc/asterisk# find /var/lib/asterisk -name vm-youhaveno*
/var/lib/asterisk/sounds/es.anterior/vm-youhaveno.wav
/var/lib/asterisk/sounds/es.anterior/vm-youhaveno.gsm
/var/lib/asterisk/ex-sounds/es.anterior/vm-youhaveno.wav
/var/lib/asterisk/ex-sounds/es.anterior/vm-youhaveno.gsm
asterisk:/etc/asterisk#