Playsms not sending msg with kannel


(Sima Cristian) #1

I have all the things up and running but it seems my playsms not sending messages. Here is my bearerbox log file. The strange thing is that if i stop bearerbox and i start it manualy with sudo bearerbox -v 0 /etc/kannel/kannel.conf it’s working.

2015-10-01 23:45:41 [4646] [0] INFO: Added logfile `/var/log/kannel/bearerbox.log' with level `0'.
2015-10-01 23:45:41 [4646] [0] INFO: Started access logfile `/var/log/kannel/access.log'.
2015-10-01 23:45:41 [4646] [0] WARNING: 'store-file' option deprecated, please use 'store-location' and 'store-type' instead.
2015-10-01 23:45:41 [4646] [0] INFO: HTTP: Opening server at port 13000.
2015-10-01 23:45:41 [4646] [0] DEBUG: Started thread 1 (gwlib/fdset.c:poller)
2015-10-01 23:45:41 [4646] [1] DEBUG: Thread 1 (gwlib/fdset.c:poller) maps to pid 4646.
2015-10-01 23:45:41 [4646] [0] DEBUG: Started thread 2 (gwlib/http.c:server_thread)
2015-10-01 23:45:41 [4646] [2] DEBUG: Thread 2 (gwlib/http.c:server_thread) maps to pid 4646.
2015-10-01 23:45:41 [4646] [0] DEBUG: Started thread 3 (gw/bb_http.c:httpadmin_run)
2015-10-01 23:45:41 [4646] [3] DEBUG: Thread 3 (gw/bb_http.c:httpadmin_run) maps to pid 4646.
2015-10-01 23:45:41 [4646] [0] DEBUG: starting smsbox connection module
2015-10-01 23:45:41 [4646] [0] DEBUG: Started thread 4 (gw/bb_boxc.c:sms_to_smsboxes)
2015-10-01 23:45:41 [4646] [4] DEBUG: Thread 4 (gw/bb_boxc.c:sms_to_smsboxes) maps to pid 4646.
2015-10-01 23:45:41 [4646] [0] DEBUG: Started thread 5 (gw/bb_boxc.c:smsboxc_run)
2015-10-01 23:45:41 [4646] [5] DEBUG: Thread 5 (gw/bb_boxc.c:smsboxc_run) maps to pid 4646.
2015-10-01 23:45:41 [4646] [0] INFO: Set SMS resend frequency to 60 seconds.
2015-10-01 23:45:41 [4646] [0] INFO: SMS resend retry set to unlimited.
2015-10-01 23:45:41 [4646] [0] DEBUG: smsbox MO concatenated message handling enabled
2015-10-01 23:45:41 [4646] [0] INFO: DLR rerouting for smsc id <mysmsc> disabled.
2015-10-01 23:45:41 [4646] [0] INFO: Added logfile `/tmp/smsc.log' with level `0'.
2015-10-01 23:45:41 [4646] [0] INFO: AT2[mysmsc]: configuration shows modemtype <huawei>
2015-10-01 23:45:41 [4646] [0] DEBUG: AT2[mysmsc]: Reading modem definitions from </etc/kannel/kannel.conf>
2015-10-01 23:45:41 [4646] [0] DEBUG: AT2[mysmsc]: Found <1> modems in config
2015-10-01 23:45:41 [4646] [0] INFO: AT2[mysmsc]: read modem definition for <Huawei>
2015-10-01 23:45:41 [4646] [0] DEBUG: Started thread 6 (gw/smsc/smsc_at.c:at2_device_thread)
2015-10-01 23:45:41 [4646] [6] DEBUG: Thread 6 (gw/smsc/smsc_at.c:at2_device_thread) maps to pid 4646.
2015-10-01 23:45:41 [4646] [6] INFO: Logging thread `6' to logfile `/tmp/smsc.log' with level `0'.
2015-10-01 23:45:41 [4646] [0] DEBUG: Started thread 7 (gw/bb_smscconn.c:sms_router)
2015-10-01 23:45:41 [4646] [0] INFO: ----------------------------------------
2015-10-01 23:45:41 [4646] [0] INFO: Kannel bearerbox II version 1.4.3 starting
2015-10-01 23:45:41 [4646] [0] INFO: Loading store file `/var/log/kannel/kannel.store'
2015-10-01 23:45:41 [4646] [0] INFO: Store-file size 382, starting to unpack
2015-10-01 23:45:41 [4646] [0] INFO: Retrieved 1 messages, non-acknowledged messages: 0
2015-10-01 23:45:41 [4646] [0] DEBUG: Started thread 8 (gw/bb_store_file.c:store_dumper)
2015-10-01 23:45:41 [4646] [8] DEBUG: Thread 8 (gw/bb_store_file.c:store_dumper) maps to pid 4646.
2015-10-01 23:45:41 [4646] [0] INFO: MAIN: Start-up done, entering mainloop
2015-10-01 23:45:41 [4646] [0] DEBUG: AT2[mysmsc]: start called
2015-10-01 23:45:41 [4646] [7] DEBUG: Thread 7 (gw/bb_smscconn.c:sms_router) maps to pid 4646.
2015-10-01 23:45:42 [4646] [5] INFO: Client connected from <127.0.0.1> 
2015-10-01 23:45:42 [4646] [5] DEBUG: Started thread 9 (gw/bb_boxc.c:function)
2015-10-01 23:45:42 [4646] [9] DEBUG: Thread 9 (gw/bb_boxc.c:function) maps to pid 4646.
2015-10-01 23:45:42 [4646] [9] DEBUG: Started thread 10 (gw/bb_boxc.c:boxc_sender)
2015-10-01 23:45:42 [4646] [10] DEBUG: Thread 10 (gw/bb_boxc.c:boxc_sender) maps to pid 4646.
2015-10-01 23:46:01 [4646] [8] DEBUG: Dumping 0 messages to store
2015-10-01 23:46:38 [4646] [9] DEBUG: boxc_receiver: sms received
2015-10-01 23:46:38 [4646] [7] DEBUG: sms_router: handling message (0xb4900ec8 vs 0xb4900ec8)
2015-10-01 23:46:38 [4646] [7] DEBUG: Routing failed, re-queued.
2015-10-01 23:46:38 [4646] [7] DEBUG: sms_router: handling message (0xb4900ec8 vs 0xb4900ec8)
2015-10-01 23:46:38 [4646] [7] DEBUG: Routing failed, re-queued.
2015-10-01 23:46:38 [4646] [7] DEBUG: sms_router: time to sleep 30.00 secs.
2015-10-01 23:46:38 [4646] [7] DEBUG: sms_router: gwlist_len = 1
2015-10-01 23:46:38 [4646] [7] DEBUG: sms_router: handling message (0xb4900ec8 vs 0xb4900ec8)
2015-10-01 23:46:38 [4646] [7] DEBUG: Routing failed, re-queued.
2015-10-01 23:46:38 [4646] [7] DEBUG: sms_router: handling message (0xb4900ec8 vs 0xb4900ec8)
2015-10-01 23:46:38 [4646] [7] DEBUG: Routing failed, re-queued.
2015-10-01 23:46:38 [4646] [7] DEBUG: sms_router: time to sleep 30.00 secs.
2015-10-01 23:46:38 [4646] [9] DEBUG: send_msg: sending msg to box: <127.0.0.1>
2015-10-01 23:46:51 [4646] [8] DEBUG: Dumping 1 messages to store
2015-10-01 23:47:08 [4646] [7] DEBUG: sms_router: gwlist_len = 1
2015-10-01 23:47:08 [4646] [7] DEBUG: sms_router: handling message (0xb4900ec8 vs 0xb4900ec8)
2015-10-01 23:47:08 [4646] [7] DEBUG: Routing failed, re-queued.
2015-10-01 23:47:08 [4646] [7] DEBUG: sms_router: handling message (0xb4900ec8 vs 0xb4900ec8)
2015-10-01 23:47:08 [4646] [7] DEBUG: Routing failed, re-queued.
2015-10-01 23:47:08 [4646] [7] DEBUG: sms_router: time to sleep 30.00 secs.
2015-10-01 23:47:38 [4646] [7] DEBUG: sms_router: gwlist_len = 1
2015-10-01 23:47:38 [4646] [7] DEBUG: sms_router: handling message (0xb4900ec8 vs 0xb4900ec8)
2015-10-01 23:47:38 [4646] [7] DEBUG: Routing failed, re-queued.
2015-10-01 23:47:38 [4646] [7] DEBUG: sms_router: handling message (0xb4900ec8 vs 0xb4900ec8)
2015-10-01 23:47:38 [4646] [7] DEBUG: Routing failed, re-queued.
2015-10-01 23:47:38 [4646] [7] DEBUG: sms_router: time to sleep 30.00 secs.
2015-10-01 23:48:08 [4646] [7] DEBUG: sms_router: gwlist_len = 1
2015-10-01 23:48:08 [4646] [7] DEBUG: sms_router: handling message (0xb4900ec8 vs 0xb4900ec8)
2015-10-01 23:48:08 [4646] [7] DEBUG: Routing failed, re-queued.

(Valentin) #2

Hi Cristian,

Did you find any fix for the above issue?

Thank you,

Valentin


(Nestor) #3

That is a problem if you installed the package with apt-get, what I recommend doing is always kill the “kannel” service and start everything manually. At least that’s how it works for me.