You first had incorrect permissions in the manager user. Now you have another problem. Both listen and whisper use chanspy to work, and the command is properly sent between the client and server, you will need to inspect the manager events from and to asterisk ( -> <- in the logs), and the asterisk full log in order to look for problems with chanspy. There are some asterisk versions where chanspy is broken( 1.4.26 or something like that). You can incresease the debug log to -X 511 and also inspect the asterisk full log or console
Best regards,
OK. Two problems at once is always hard to fix!
Here is my -X 511 output:
** MAIN AMI event received... ** MAIN There's an 'Event' in the event block ** MAIN Event detected block_count = 0 ** MAIN There are 0 blocks for processing ** MAIN Answer block cleared ** DIGEST_EVENT: start ** PROCESA_BLOQUE RTCPRECEIVED 0 ** MAIN AMI event received... ** MAIN Processing command received from flash clients... 10.10.8.111 <= <msg data="15|towhisper|12|f530f3d19ae1d9b661e9102167c3abad" /> -- PROCESS_FLASH_COMMAND origen 15 accion towhisper destino 12 -- PROCESS_FLASH_COMMAND password [string] VALIDAR USUARIO 244 Validation ok, have all permissions TO WHISPER permission denied, privacy in destination button! ** MAIN End of block from localhost 127.0.0.1 <- Event: RTCPSent 127.0.0.1 <- Privilege: reporting,all 127.0.0.1 <- To: 172.16.8.196:3001 127.0.0.1 <- OurSSRC: 930506050 127.0.0.1 <- SentNTP: 1280220188.3181875200 127.0.0.1 <- SentRTP: 930497584 127.0.0.1 <- SentPackets: 1249 127.0.0.1 <- SentOctets: 199840 127.0.0.1 <- ReportBlock: 127.0.0.1 <- FractionLost: 0 127.0.0.1 <- CumulativeLoss: 0 127.0.0.1 <- IAJitter: 0.0000 127.0.0.1 <- TheirLastSR: 2879153766 127.0.0.1 <- DLSR: 3.0790 (sec) 127.0.0.1 <- Server: 0
Only one line was output in /etc/log/asterisk/full:
[Jul 27 00:43:11] VERBOSE[12757] logger.c: == Manager 'admin' logged off from 127.0.0.1
And this didn't repeat on subsequent clicks, so I don't think it's related.
It appears the log is saying the button has privacy enabled. I went into fop2admin and changed privacy from "all" to "none" (note, it might be better to clarify the mouseover text in future releases of fop2admin). After dong that, the logs changed to this:
** MAIN AMI event received... ** MAIN There's an 'Event' in the event block ** MAIN Event detected block_count = 0 ** MAIN There are 0 blocks for processing ** MAIN Answer block cleared ** DIGEST_EVENT: start ** PROCESA_BLOQUE RTCPSENT 0 ** MAIN End of block from localhost 127.0.0.1 <- Event: RTCPSent 127.0.0.1 <- Privilege: reporting,all 127.0.0.1 <- To: 172.16.8.198:3001 127.0.0.1 <- OurSSRC: 1999275949 127.0.0.1 <- SentNTP: 1280220498.3180355584 127.0.0.1 <- SentRTP: 22756960 127.0.0.1 <- SentPackets: 16751 127.0.0.1 <- SentOctets: 2680160 127.0.0.1 <- ReportBlock: 127.0.0.1 <- FractionLost: 0 127.0.0.1 <- CumulativeLoss: 0 127.0.0.1 <- IAJitter: 0.0000 127.0.0.1 <- TheirLastSR: 2899427328 127.0.0.1 <- DLSR: 2.6380 (sec) 127.0.0.1 <- Server: 0 ** MAIN AMI event received... ** MAIN There's an 'Event' in the event block ** MAIN Event detected block_count = 0 ** MAIN There are 0 blocks for processing ** MAIN Answer block cleared ** DIGEST_EVENT: start ** PROCESA_BLOQUE RTCPSENT 0 ** MAIN AMI event received... ** MAIN Processing command received from flash clients... 10.10.8.111 <= <msg data="15|tospy|12|0c1144c012fcdc1c4cd7092df3146c44" /> -- PROCESS_FLASH_COMMAND origen 15 accion tospy destino 12 -- PROCESS_FLASH_COMMAND password [string] VALIDAR USUARIO 244 Validation ok, have all permissions Not a reference at all Not a reference at all TO SPY SIP/244 no definido! ** MAIN End of block from localhost 127.0.0.1 <- Event: RTCPReceived 127.0.0.1 <- Privilege: reporting,all 127.0.0.1 <- From: 172.16.8.196:3001 127.0.0.1 <- PT: 200(Sender Report) 127.0.0.1 <- ReceptionReports: 1 127.0.0.1 <- SenderSSRC: 0 127.0.0.1 <- FractionLost: 0 127.0.0.1 <- PacketsLost: 0 127.0.0.1 <- HighestSequence: 49947 127.0.0.1 <- SequenceNumberCycles: 0 127.0.0.1 <- IAJitter: 0 127.0.0.1 <- LastSR: 7122.0536870912 127.0.0.1 <- DLSR: 1.9000(sec) 127.0.0.1 <- RTT: 10(sec) 127.0.0.1 <- Server: 0 ** MAIN AMI event received... ** MAIN There's an 'Event' in the event block ** MAIN Event detected block_count = 0 ** MAIN There are 0 blocks for processing ** MAIN Answer block cleared ** DIGEST_EVENT: start ** PROCESA_BLOQUE RTCPRECEIVED 0 ** MAIN End of block from localhost 127.0.0.1 <- Event: RTCPReceived 127.0.0.1 <- Privilege: reporting,all 127.0.0.1 <- From: 172.16.8.198:3001 127.0.0.1 <- PT: 200(Sender Report) 127.0.0.1 <- ReceptionReports: 1 127.0.0.1 <- SenderSSRC: 0 127.0.0.1 <- FractionLost: 0 127.0.0.1 <- PacketsLost: 0 127.0.0.1 <- HighestSequence: 1186 127.0.0.1 <- SequenceNumberCycles: 0 127.0.0.1 <- IAJitter: 0 127.0.0.1 <- LastSR: 7122.1342177280 127.0.0.1 <- DLSR: 2.3500(sec) 127.0.0.1 <- RTT: 11(sec) 127.0.0.1 <- Server: 0 ** MAIN AMI event received... ** MAIN There's an 'Event' in the event block ** MAIN Event detected block_count = 0 ** MAIN There are 0 blocks for processing ** MAIN Answer block cleared ** DIGEST_EVENT: start ** PROCESA_BLOQUE RTCPRECEIVED 0 ** MAIN AMI event received... ** MAIN Processing command received from flash clients... 10.10.8.111 <= <msg data="15|towhisper|15|0c1144c012fcdc1c4cd7092df3146c44" /> -- PROCESS_FLASH_COMMAND origen 15 accion towhisper destino 15 -- PROCESS_FLASH_COMMAND password [string] VALIDAR USUARIO 244 Validation ok, have all permissions Not a reference at all Not a reference at all TO WHISPER SIP/244 no definido! ** MAIN AMI event received... ** MAIN Processing command received from flash clients... 10.10.8.111 <= <msg data="15|tospy|15|0c1144c012fcdc1c4cd7092df3146c44" /> -- PROCESS_FLASH_COMMAND origen 15 accion tospy destino 15 -- PROCESS_FLASH_COMMAND password [string] VALIDAR USUARIO 244 Validation ok, have all permissions Not a reference at all Not a reference at all TO SPY SIP/244 no definido! ** MAIN End of block from localhost 127.0.0.1 <- Event: RTCPSent 127.0.0.1 <- Privilege: reporting,all 127.0.0.1 <- To: 172.16.8.196:3001 127.0.0.1 <- OurSSRC: 930506050 127.0.0.1 <- SentNTP: 1280220503.3180752896 127.0.0.1 <- SentRTP: 933017584 127.0.0.1 <- SentPackets: 16999 127.0.0.1 <- SentOctets: 2719840 127.0.0.1 <- ReportBlock: 127.0.0.1 <- FractionLost: 0 127.0.0.1 <- CumulativeLoss: 0 127.0.0.1 <- IAJitter: 0.0000 127.0.0.1 <- TheirLastSR: 2899797606 127.0.0.1 <- DLSR: 3.0900 (sec) 127.0.0.1 <- Server: 0 ** MAIN AMI event received... ** MAIN There's an 'Event' in the event block ** MAIN Event detected block_count = 0 ** MAIN There are 0 blocks for processing ** MAIN Answer block cleared ** DIGEST_EVENT: start ** PROCESA_BLOQUE RTCPSENT 0 ** MAIN End of block from localhost 127.0.0.1 <- Event: RTCPSent 127.0.0.1 <- Privilege: reporting,all 127.0.0.1 <- To: 172.16.8.198:3001 127.0.0.1 <- OurSSRC: 1999275949 127.0.0.1 <- SentNTP: 1280220503.3180945408 127.0.0.1 <- SentRTP: 22796960 127.0.0.1 <- SentPackets: 17001 127.0.0.1 <- SentOctets: 2720160 127.0.0.1 <- ReportBlock: 127.0.0.1 <- FractionLost: 0 127.0.0.1 <- CumulativeLoss: 0 127.0.0.1 <- IAJitter: 0.0001 127.0.0.1 <- TheirLastSR: 2899755008 127.0.0.1 <- DLSR: 2.6380 (sec) 127.0.0.1 <- Server: 0 ** MAIN AMI event received... ** MAIN There's an 'Event' in the event block ** MAIN Event detected block_count = 0 ** MAIN There are 0 blocks for processing ** MAIN Answer block cleared ** DIGEST_EVENT: start ** PROCESA_BLOQUE RTCPSENT 0 Exiting...
My Asterisk is 1.6.0.10 as part of Trixbox 2.8.0.3. Chanspy does work if I dial 555.