Kannel - Error in AT+CNMI command

Sun Jun 17 18:18:17 CEST 2007

Hi All,

We are using Kannel 1.4.1 with Nokia 5300 (connected using USB cable).
Nokia 5300 is set to Nokia mode (out of 3 modes given - Nokia Mode, Printing
and Media Mode and Data Mode).
When bearerebox is started, it gives error while executing one of the AT
command i.e AT+CNMI=1,2,0,1,0
We tried executing AT commands using minicom but still we were getting same
problem.
Can anybody please suggest solution to this problem?
Right now, we have just guessed the values for detect-string so if there is
any AT command to figure out these values or real values, do let us know.

Please find smskannle.conf and error log below:

In smskannel.conf, here is the configuration of relevant portion (modem and
smsc part).

#---------------------------------------------
# SMSC CONNECTIONS
#
# SMSC connections are created in bearerbox and they handle SMSC specific
# protocol and message relying. You need these to actually receive and send
# messages to handset, but can use GSM modems as virtual SMSCs

# This is a fake smsc connection, _only_ used to test the system and
services.
# It really cannot relay messages to actual handsets!

# group = smsc
# smsc = fake
# smsc-id = FAKE
# port = 10000
# connect-allow-ip = 127.0.0.1

group = smsc
smsc = at
modemtype = Nokia
my-number = 919844142580
#device = /dev/ttyS0
device = /dev/ttyACM0
speed = 19200

#
------------------------------------------------------------------------------
# modem definitions
#
------------------------------------------------------------------------------

group = modems
id = Nokia
name = Nokia
#detect-string = "Nokia"
#init-string=ATE0
detect-string = "5300"
detect-string2 = "NOKIA"
message-storage = "SM"
#need-sleep = true

Please find full smskannel.conf at bottom of message.

Here is the error we are getting when we run bearerbox.

2007-06-17 21:40:09 [11275] [0] INFO: Debug_lvl = 0, log_file = <none>,
log_lvl = 0
2007-06-17 21:40:09 [11275] [0] WARNING: DLR: using default 'internal' for
storage type.
2007-06-17 21:40:09 [11275] [0] INFO: DLR using storage type: internal
2007-06-17 21:40:09 [11275] [0] DEBUG: Kannel bearerbox version `1.4.1'.
Build `Jun 12 2007 00:33:20', compiler `3.4.6 20060404 (Red Hat 3.4.6-3)'.
System Linux, release 2.6.9-42.EL, version #1 Sat Aug 12 09:17:58 CDT 2006,
machine i686.
Hostname localhost.localdomain, IP 127.0.0.1.
Libxml version 2.6.16.
Using OpenSSL 0.9.7a Feb 19 2003.
Using native malloc.

2007-06-17 21:40:09 [11275] [0] INFO: Added logfile `/root/kannel.log' with
level `0'.
2007-06-17 21:40:09 [11275] [0] INFO: HTTP: Opening server at port 13000.
2007-06-17 21:40:09 [11275] [0] DEBUG: Started thread 1
(gwlib/fdset.c:poller)
2007-06-17 21:40:09 [11275] [0] DEBUG: Started thread 2
(gwlib/http.c:server_thread)
2007-06-17 21:40:09 [11275] [0] DEBUG: Started thread 3
(gw/bb_http.c:httpadmin_run)
2007-06-17 21:40:09 [11275] [0] DEBUG: starting smsbox connection module
2007-06-17 21:40:09 [11275] [0] INFO: BOXC: 'smsbox-max-pending' not set,
using default (100).
2007-06-17 21:40:09 [11275] [1] DEBUG: Thread 1 (gwlib/fdset.c:poller) maps
to pid 11275.
2007-06-17 21:40:09 [11275] [2] DEBUG: Thread 2 (gwlib/http.c:server_thread)
maps to pid 11275.
2007-06-17 21:40:09 [11275] [3] DEBUG: Thread 3 (gw/bb_http.c:httpadmin_run)
maps to pid 11275.
2007-06-17 21:40:09 [11275] [4] DEBUG: Thread 4
(gw/bb_boxc.c:sms_to_smsboxes) maps to pid 11275.
2007-06-17 21:40:09 [11275] [0] DEBUG: Started thread 4
(gw/bb_boxc.c:sms_to_smsboxes)
2007-06-17 21:40:09 [11275] [0] DEBUG: Started thread 5
(gw/bb_boxc.c:smsboxc_run)
2007-06-17 21:40:09 [11275] [0] INFO: Set SMS resend frequency to 60
seconds.
2007-06-17 21:40:10 [11275] [0] INFO: SMS resend retry set to unlimited.
2007-06-17 21:40:10 [11275] [0] INFO: DLR rerouting for smsc id <(null)>
disabled.
2007-06-17 21:40:10 [11275] [0] INFO: AT2[/dev/ttyACM0]: configuration shows
modemtype <Nokia>
2007-06-17 21:40:10 [11275] [0] DEBUG: AT2[/dev/ttyACM0]: Reading modem
definitions from <../smskannel.conf>
2007-06-17 21:40:10 [11275] [0] DEBUG: AT2[/dev/ttyACM0]: Found <1> modems
in config
2007-06-17 21:40:10 [11275] [5] DEBUG: Thread 5 (gw/bb_boxc.c:smsboxc_run)
maps to pid 11275.
2007-06-17 21:40:10 [11275] [0] INFO: AT2[/dev/ttyACM0]: read modem
definition for <Nokia>
2007-06-17 21:40:10 [11275] [0] DEBUG: Started thread 6
(gw/smsc/smsc_at.c:at2_device_thread)
2007-06-17 21:40:10 [11275] [0] DEBUG: Started thread 7
(gw/bb_smscconn.c:sms_router)
2007-06-17 21:40:10 [11275] [0] INFO:
----------------------------------------
2007-06-17 21:40:10 [11275] [0] INFO: Kannel bearerbox II version 1.4.1starting
2007-06-17 21:40:10 [11275] [0] INFO: MAIN: Start-up done, entering mainloop
2007-06-17 21:40:10 [11275] [0] DEBUG: AT2[/dev/ttyACM0]: start called
2007-06-17 21:40:10 [11275] [6] DEBUG: Thread 6
(gw/smsc/smsc_at.c:at2_device_thread) maps to pid 11275.
2007-06-17 21:40:10 [11275] [6] INFO: AT2[/dev/ttyACM0]: opening device
2007-06-17 21:40:10 [11275] [7] DEBUG: Thread 7
(gw/bb_smscconn.c:sms_router) maps to pid 11275.
2007-06-17 21:40:10 [11275] [7] DEBUG: sms_router: time to sleep 30.00 secs.
2007-06-17 21:40:10 [11275] [7] DEBUG: sms_router: gwlist_len = 0
2007-06-17 21:40:10 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: device opened
2007-06-17 21:40:10 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: device opened
2007-06-17 21:40:10 [11275] [6] INFO: AT2[/dev/ttyACM0]: init device
2007-06-17 21:40:10 [11275] [6] INFO: AT2[/dev/ttyACM0]: speed set to 19200
2007-06-17 21:40:10 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: --> ATZ^M
2007-06-17 21:40:10 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: <-- ATZ
2007-06-17 21:40:10 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: <-- OK
2007-06-17 21:40:10 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: --> AT^M
2007-06-17 21:40:10 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: <-- AT
2007-06-17 21:40:10 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: <-- OK
2007-06-17 21:40:10 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: --> AT&F^M
2007-06-17 21:40:10 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: <-- AT&F
2007-06-17 21:40:10 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: <-- OK
2007-06-17 21:40:10 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: --> ATE0^M
2007-06-17 21:40:10 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: <-- ATE0
2007-06-17 21:40:10 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: <-- OK
2007-06-17 21:40:10 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: --> AT+IFC=2,2^M
2007-06-17 21:40:10 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: <-- OK
2007-06-17 21:40:10 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: --> AT+CPIN?^M
2007-06-17 21:40:11 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: <-- +CPIN: READY
2007-06-17 21:40:11 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: <-- OK
2007-06-17 21:40:11 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: --> AT+CMGF=0^M
2007-06-17 21:40:11 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: <-- OK
2007-06-17 21:40:11 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: --> AT+CSMS=?^M
2007-06-17 21:40:11 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: <-- +CSMS: (0)
2007-06-17 21:40:11 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: <-- OK
2007-06-17 21:40:11 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: -->
AT+CNMI=1,2,0,1,0^M
2007-06-17 21:40:11 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: <-- ERROR
2007-06-17 21:40:11 [11275] [6] ERROR: AT2[/dev/ttyACM0]: Generic error:
ERROR
2007-06-17 21:40:11 [11275] [6] ERROR: AT2[/dev/ttyACM0]: Opening failed.
Terminating
2007-06-17 21:40:11 [11275] [6] INFO: AT2[/dev/ttyACM0]: closing device
2007-06-17 21:40:11 [11275] [6] INFO: AT2[/dev/ttyACM0]: opening device
2007-06-17 21:40:11 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: device opened
2007-06-17 21:40:11 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: device opened
2007-06-17 21:40:11 [11275] [6] INFO: AT2[/dev/ttyACM0]: init device
2007-06-17 21:40:11 [11275] [6] INFO: AT2[/dev/ttyACM0]: speed set to 19200
2007-06-17 21:40:11 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: --> ATZ^M
2007-06-17 21:40:14 [11275] [0] WARNING: Killing signal or HTTP admin
command received, shutting down...
2007-06-17 21:40:14 [11275] [0] DEBUG: Shutting down Kannel...
2007-06-17 21:40:14 [11275] [0] DEBUG: shutting down smsc
2007-06-17 21:40:14 [11275] [0] DEBUG: AT2[/dev/ttyACM0]: Shutting down
SMSCConn, slow
2007-06-17 21:40:14 [11275] [0] DEBUG: shutting down udp
2007-06-17 21:40:15 [11275] [6] ERROR: AT2[/dev/ttyACM0]: Wrong or no answer
to ATZ, ignoring
2007-06-17 21:40:15 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: --> AT^M
2007-06-17 21:40:15 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: <-- AT
2007-06-17 21:40:15 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: <-- OK
2007-06-17 21:40:15 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: --> AT&F^M
2007-06-17 21:40:15 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: <-- AT&F
2007-06-17 21:40:15 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: <-- OK
2007-06-17 21:40:15 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: --> ATE0^M
2007-06-17 21:40:15 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: <-- ATE0
2007-06-17 21:40:15 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: <-- OK
2007-06-17 21:40:15 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: --> AT+IFC=2,2^M
2007-06-17 21:40:15 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: <-- OK
2007-06-17 21:40:15 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: --> AT+CPIN?^M
2007-06-17 21:40:15 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: <-- +CPIN: READY
2007-06-17 21:40:15 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: <-- OK
2007-06-17 21:40:15 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: --> AT+CMGF=0^M
2007-06-17 21:40:15 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: <-- OK
2007-06-17 21:40:15 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: --> AT+CSMS=?^M
2007-06-17 21:40:15 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: <-- +CSMS: (0)
2007-06-17 21:40:15 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: <-- OK
2007-06-17 21:40:15 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: -->
AT+CNMI=1,2,0,1,0^M
2007-06-17 21:40:15 [11275] [6] DEBUG: AT2[/dev/ttyACM0]: <-- ERROR
2007-06-17 21:40:15 [11275] [6] ERROR: AT2[/dev/ttyACM0]: Generic error:
ERROR
2007-06-17 21:40:15 [11275] [6] ERROR: AT2[/dev/ttyACM0]: Opening failed.
Terminating
2007-06-17 21:40:15 [11275] [6] INFO: AT2[/dev/ttyACM0]: closing device
2007-06-17 21:40:15 [11275] [6] INFO: AT2[/dev/ttyACM0]: closing device
2007-06-17 21:40:15 [11275] [6] DEBUG: Thread 6
(gw/smsc/smsc_at.c:at2_device_thread) terminates.
2007-06-17 21:40:15 [11275] [7] DEBUG: Thread 7
(gw/bb_smscconn.c:sms_router) terminates.
2007-06-17 21:40:15 [11275] [4] DEBUG: Thread 4
(gw/bb_boxc.c:sms_to_smsboxes) terminates.
2007-06-17 21:40:15 [11275] [5] DEBUG: Thread 5 (gw/bb_boxc.c:smsboxc_run)
terminates.
2007-06-17 21:40:15 [11275] [0] INFO: All flow threads have died, killing
core
2007-06-17 21:40:15 [11275] [0] DEBUG: Waiting for 2
(gwlib/http.c:server_thread) to terminate
2007-06-17 21:40:15 [11275] [3] DEBUG: HTTP: No clients with requests,
quitting.
2007-06-17 21:40:15 [11275] [3] DEBUG: Thread 3 (gw/bb_http.c:httpadmin_run)
terminates.
2007-06-17 21:40:15 [11275] [2] DEBUG: Thread 2 (gwlib/http.c:server_thread)
terminates.
2007-06-17 21:40:16 [11275] [1] DEBUG: Thread 1 (gwlib/fdset.c:poller)
terminates.
2007-06-17 21:40:16 [11275] [0] INFO: Total WDP messages: received 0, sent 0
2007-06-17 21:40:16 [11275] [0] INFO: Total SMS messages: received 0, sent 0
2007-06-17 21:40:16 [11275] [0] DEBUG: Immutable octet strings: 210.

-- 
Regards
Bhagwandas Paliwal
-------------- next part --------------
An HTML attachment was scrubbed...
URL: http://www.kannel.org/pipermail/commercial/attachments/20070617/03ec52d2/attachment.html 