Kannel logs Deliver_sm as receive_sm !

classic Classic list List threaded Threaded
2 messages Options
Reply | Threaded
Open this post in threaded view
|  
Report Content as Inappropriate

Kannel logs Deliver_sm as receive_sm !

Ahmed Shabana-3

Dears ,

 

I face strange issue with my Kannel with a new smsc  connection

 

Although the provider pack dlr properly as shown in below logs in Deliver_SM PDU but kannel bb access log show them as “Receive SMS “ !!

 

 

Kannel logs

2016-05-22 10:39:28 Sent SMS [SMSC:xxxx] [ACT:] [FID:14639063686890014103] [from:SMS] [to:20100xxxx] [msg:27:hellooooooo..xxx] [META:?smpp_resp?] [udh:0:]

2016-05-22 10:39:29 Receive SMS [SMSC:xxxx] [ACT:xxx_xx] [FID:14639063686890014103] [from:+20100xxxx] [to:...] [msg:112:id:14639063686890014103 sub:001 dlvrd:001 submit date:1605221039 done date:1605221039 stat:DELIVRD err:000 text:] [META:?smpp?] [udh:0:]

2016-05-22 10:40:14 Receive SMS [SMSC:xxxxx] [ACT:xxxxx] [FID:14639063686890014103] [from:+20100xxxx] [to:...] [msg:109:id:14639063686890014103 sub:001 dlvrd:001 submit date:1605221040 done date:1605221040 stat:SEEN err:000 text:] [META:?smpp?] [udh:0:]

 

 

PDU logs

 

2016-05-22 10:39:28 [15726] [68] DEBUG: SMPP PDU 0x7f6b4c00b8d0 dump:

2016-05-22 10:39:28 [15726] [68] DEBUG:   type_name: submit_sm

2016-05-22 10:39:28 [15726] [68] DEBUG:   command_id: 4 = 0x00000004

2016-05-22 10:39:28 [15726] [68] DEBUG:   command_status: 0 = 0x00000000

2016-05-22 10:39:28 [15726] [68] DEBUG:   sequence_number: 78 = 0x0000004e

2016-05-22 10:39:28 [15726] [68] DEBUG:   service_type: NULL

2016-05-22 10:39:28 [15726] [68] DEBUG:   source_addr_ton: 5 = 0x00000005

2016-05-22 10:39:28 [15726] [68] DEBUG:   source_addr_npi: 0 = 0x00000000

2016-05-22 10:39:28 [15726] [68] DEBUG:   source_addr: "SMS"

2016-05-22 10:39:28 [15726] [68] DEBUG:   dest_addr_ton: 1 = 0x00000001

2016-05-22 10:39:28 [15726] [68] DEBUG:   dest_addr_npi: 0 = 0x00000000

2016-05-22 10:39:28 [15726] [68] DEBUG:   destination_addr: "20100xxxx"

2016-05-22 10:39:28 [15726] [68] DEBUG:   esm_class: 3 = 0x00000003

2016-05-22 10:39:28 [15726] [68] DEBUG:   protocol_id: 0 = 0x00000000

2016-05-22 10:39:28 [15726] [68] DEBUG:   priority_flag: 0 = 0x00000000

2016-05-22 10:39:28 [15726] [68] DEBUG:   schedule_delivery_time: NULL

2016-05-22 10:39:28 [15726] [68] DEBUG:   validity_period: NULL

2016-05-22 10:39:28 [15726] [68] DEBUG:   registered_delivery: 17 = 0x00000011

2016-05-22 10:39:28 [15726] [68] DEBUG:   replace_if_present_flag: 0 = 0x00000000

2016-05-22 10:39:28 [15726] [68] DEBUG:   data_coding: 0 = 0x00000000

2016-05-22 10:39:28 [15726] [68] DEBUG:   sm_default_msg_id: 0 = 0x00000000

2016-05-22 10:39:28 [15726] [68] DEBUG:   sm_length: 27 = 0x0000001b

2016-05-22 10:39:28 [15726] [68] DEBUG:   short_message:

2016-05-22 10:39:28 [15726] [68] DEBUG:    Octet string at 0x7f6b4c000fc0:

2016-05-22 10:39:28 [15726] [68] DEBUG:      len:  27

2016-05-22 10:39:28 [15726] [68] DEBUG:      size: 28

2016-05-22 10:39:28 [15726] [68] DEBUG:      immutable: 0

2016-05-22 10:39:28 [15726] [68] DEBUG:      data: 68 65 6c 6c 6f 6f 6f 6f 6f 6f 6f 0d 0a 4c 69 6e   hellooooooo..Lin

2016-05-22 10:39:28 [15726] [68] DEBUG:      .

2016-05-22 10:39:28 [15726] [68] DEBUG:      .

2016-05-22 10:39:28 [15726] [68] DEBUG:    Octet string dump ends.

2016-05-22 10:39:28 [15726] [68] DEBUG: SMPP PDU dump ends.

2016-05-22 10:39:28 [15726] [68] DEBUG: SMPP[xxxx]: throughput (1.00,0.00)

2016-05-22 10:39:28 [15726] [68] DEBUG: SMPP[xxxx]: throughput (1.00,0.00)

2016-05-22 10:39:28 [15726] [68] DEBUG: SMPP[xxxx]: Got PDU:

2016-05-22 10:39:28 [15726] [68] DEBUG: SMPP PDU 0x7f6b4c00b8d0 dump:

2016-05-22 10:39:28 [15726] [68] DEBUG:   type_name: submit_sm_resp

2016-05-22 10:39:28 [15726] [68] DEBUG:   command_id: 2147483652 = 0x80000004

2016-05-22 10:39:28 [15726] [68] DEBUG:   command_status: 0 = 0x00000000

2016-05-22 10:39:28 [15726] [68] DEBUG:   sequence_number: 78 = 0x0000004e

2016-05-22 10:39:28 [15726] [68] DEBUG:   message_id:

2016-05-22 10:39:28 [15726] [68] DEBUG:    Octet string at 0x7f6b4c000d30:

2016-05-22 10:39:28 [15726] [68] DEBUG:      len:  20

2016-05-22 10:39:28 [15726] [68] DEBUG:      size: 21

2016-05-22 10:39:28 [15726] [68] DEBUG:      immutable: 0

2016-05-22 10:39:28 [15726] [68] DEBUG:      data: 31 34 36 33 39 30 36 33 36 38 36 38 39 30 30 31   1463906368689001

2016-05-22 10:39:28 [15726] [68] DEBUG:      data: 34 31 30 33                                       4103

2016-05-22 10:39:28 [15726] [68] DEBUG:    Octet string dump ends.

2016-05-22 10:39:28 [15726] [68] DEBUG: SMPP PDU dump ends.

2016-05-22 10:39:28 [15726] [68] DEBUG: DLR[mysql]: Adding DLR smsc=xxxx, ts=14639063686890014103, src=SMS, dst=201003441970, mask=7, boxc=kannel5

2016-05-22 10:39:28 [15726] [68] DEBUG: adding DLR entry into database

2016-05-22 10:39:28 [15726] [68] DEBUG: sql: INSERT INTO `dlr3` (`smsc`, `ts`, `source`, `destination`, `service`, `url`, `mask`, `boxc`, `status`) VALUES (?, ?, ?, ?, ?, ?, ?, ?, 0)

2016-05-22 10:39:28 [15726] [68] DEBUG: SMPP[xxxxx]: throughput (1.00,0.00)

-----------

2016-05-22 10:39:29 [15726] [68] DEBUG:   type_name: deliver_sm

2016-05-22 10:39:29 [15726] [68] DEBUG:   command_id: 5 = 0x00000005

2016-05-22 10:39:29 [15726] [68] DEBUG:   command_status: 0 = 0x00000000

2016-05-22 10:39:29 [15726] [68] DEBUG:   sequence_number: 2 = 0x00000002

2016-05-22 10:39:29 [15726] [68] DEBUG:   service_type: NULL

2016-05-22 10:39:29 [15726] [68] DEBUG:   source_addr_ton: 1 = 0x00000001

2016-05-22 10:39:29 [15726] [68] DEBUG:   source_addr_npi: 1 = 0x00000001

2016-05-22 10:39:29 [15726] [68] DEBUG:   source_addr: "2010xxxx"

2016-05-22 10:39:29 [15726] [68] DEBUG:   dest_addr_ton: 5 = 0x00000005

2016-05-22 10:39:29 [15726] [68] DEBUG:   dest_addr_npi: 0 = 0x00000000

2016-05-22 10:39:29 [15726] [68] DEBUG:   destination_addr: "..."

2016-05-22 10:39:29 [15726] [68] DEBUG:   esm_class: 0 = 0x00000000

2016-05-22 10:39:29 [15726] [68] DEBUG:   protocol_id: 0 = 0x00000000

2016-05-22 10:39:29 [15726] [68] DEBUG:   priority_flag: 0 = 0x00000000

2016-05-22 10:39:29 [15726] [68] DEBUG:   schedule_delivery_time: NULL

2016-05-22 10:39:29 [15726] [68] DEBUG:   validity_period: NULL

2016-05-22 10:39:29 [15726] [68] DEBUG:   registered_delivery: 0 = 0x00000000

2016-05-22 10:39:29 [15726] [68] DEBUG:   replace_if_present_flag: 0 = 0x00000000

2016-05-22 10:39:29 [15726] [68] DEBUG:   data_coding: 0 = 0x00000000

2016-05-22 10:39:29 [15726] [68] DEBUG:   sm_default_msg_id: 0 = 0x00000000

2016-05-22 10:39:29 [15726] [68] DEBUG:   sm_length: 112 = 0x00000070

2016-05-22 10:39:29 [15726] [68] DEBUG:   short_message:

2016-05-22 10:39:29 [15726] [68] DEBUG:    Octet string at 0x7f6b4c000f40:

2016-05-22 10:39:29 [15726] [68] DEBUG:      len:  112

2016-05-22 10:39:29 [15726] [68] DEBUG:      size: 113

2016-05-22 10:39:29 [15726] [68] DEBUG:      immutable: 0

2016-05-22 10:39:29 [15726] [68] DEBUG:      data: 69 64 3a 31 34 36 33 39 30 36 33 36 38 36 38 39   id:1463906368689

2016-05-22 10:39:29 [15726] [68] DEBUG:      data: 30 30 31 34 31 30 33 20 73 75 62 3a 30 30 31 20   0014103 sub:001

2016-05-22 10:39:29 [15726] [68] DEBUG:      data: 64 6c 76 72 64 3a 30 30 31 20 73 75 62 6d 69 74   dlvrd:001 submit

2016-05-22 10:39:29 [15726] [68] DEBUG:      data: 20 64 61 74 65 3a 31 36 30 35 32 32 31 30 33 39    date:1605221039

2016-05-22 10:39:29 [15726] [68] DEBUG:      data: 20 64 6f 6e 65 20 64 61 74 65 3a 31 36 30 35 32    done date:16052

2016-05-22 10:39:29 [15726] [68] DEBUG:      data: 32 31 30 33 39 20 73 74 61 74 3a 44 45 4c 49 56   21039 stat:DELIV

2016-05-22 10:39:29 [15726] [68] DEBUG:      data: 52 44 20 65 72 72 3a 30 30 30 20 74 65 78 74 3a   RD err:000 text:

2016-05-22 10:39:29 [15726] [68] DEBUG:    Octet string dump ends.

2016-05-22 10:39:29 [15726] [68] DEBUG:   message_state: 2 = 0x00000002

2016-05-22 10:39:29 [15726] [68] DEBUG:   receipted_message_id:

2016-05-22 10:39:29 [15726] [68] DEBUG:    Octet string at 0x7f6b4c00b9a0:

2016-05-22 10:39:29 [15726] [68] DEBUG:      len:  20

2016-05-22 10:39:29 [15726] [68] DEBUG:      size: 21

2016-05-22 10:39:29 [15726] [68] DEBUG:      immutable: 0

2016-05-22 10:39:29 [15726] [68] DEBUG:      data: 31 34 36 33 39 30 36 33 36 38 36 38 39 30 30 31   1463906368689001

2016-05-22 10:39:29 [15726] [68] DEBUG:      data: 34 31 30 33                                       4103

2016-05-22 10:39:29 [15726] [68] DEBUG:    Octet string dump ends.

2016-05-22 10:39:29 [15726] [68] DEBUG: SMPP PDU dump ends.

 

 

2016-05-22 10:40:14 [15726] [68] DEBUG: SMPP PDU 0x7f6b4c00c530 dump:

2016-05-22 10:40:14 [15726] [68] DEBUG:   type_name: deliver_sm

2016-05-22 10:40:14 [15726] [68] DEBUG:   command_id: 5 = 0x00000005

2016-05-22 10:40:14 [15726] [68] DEBUG:   command_status: 0 = 0x00000000

2016-05-22 10:40:14 [15726] [68] DEBUG:   sequence_number: 3 = 0x00000003

2016-05-22 10:40:14 [15726] [68] DEBUG:   service_type: NULL

2016-05-22 10:40:14 [15726] [68] DEBUG:   source_addr_ton: 1 = 0x00000001

2016-05-22 10:40:14 [15726] [68] DEBUG:   source_addr_npi: 1 = 0x00000001

2016-05-22 10:40:14 [15726] [68] DEBUG:   source_addr: "201003441970"

2016-05-22 10:40:14 [15726] [68] DEBUG:   dest_addr_ton: 5 = 0x00000005

2016-05-22 10:40:14 [15726] [68] DEBUG:   dest_addr_npi: 0 = 0x00000000

2016-05-22 10:40:14 [15726] [68] DEBUG:   destination_addr: "..."

2016-05-22 10:40:14 [15726] [68] DEBUG:   esm_class: 0 = 0x00000000

2016-05-22 10:40:14 [15726] [68] DEBUG:   protocol_id: 0 = 0x00000000

2016-05-22 10:40:14 [15726] [68] DEBUG:   priority_flag: 0 = 0x00000000

2016-05-22 10:40:14 [15726] [68] DEBUG:   schedule_delivery_time: NULL

2016-05-22 10:40:14 [15726] [68] DEBUG:   validity_period: NULL

2016-05-22 10:40:14 [15726] [68] DEBUG:   registered_delivery: 0 = 0x00000000

2016-05-22 10:40:14 [15726] [68] DEBUG:   replace_if_present_flag: 0 = 0x00000000

2016-05-22 10:40:14 [15726] [68] DEBUG:   data_coding: 0 = 0x00000000

2016-05-22 10:40:14 [15726] [68] DEBUG:   sm_default_msg_id: 0 = 0x00000000

2016-05-22 10:40:14 [15726] [68] DEBUG:   sm_length: 109 = 0x0000006d

2016-05-22 10:40:14 [15726] [68] DEBUG:   short_message:

2016-05-22 10:40:14 [15726] [68] DEBUG:    Octet string at 0x7f6b4c00bb60:

2016-05-22 10:40:14 [15726] [68] DEBUG:      len:  109

2016-05-22 10:40:14 [15726] [68] DEBUG:      size: 110

2016-05-22 10:40:14 [15726] [68] DEBUG:      immutable: 0

2016-05-22 10:40:14 [15726] [68] DEBUG:      data: 69 64 3a 31 34 36 33 39 30 36 33 36 38 36 38 39   id:1463906368689

2016-05-22 10:40:14 [15726] [68] DEBUG:      data: 30 30 31 34 31 30 33 20 73 75 62 3a 30 30 31 20   0014103 sub:001

2016-05-22 10:40:14 [15726] [68] DEBUG:      data: 64 6c 76 72 64 3a 30 30 31 20 73 75 62 6d 69 74   dlvrd:001 submit

2016-05-22 10:40:14 [15726] [68] DEBUG:      data: 20 64 61 74 65 3a 31 36 30 35 32 32 31 30 34 30    date:1605221040

2016-05-22 10:40:14 [15726] [68] DEBUG:      data: 20 64 6f 6e 65 20 64 61 74 65 3a 31 36 30 35 32    done date:16052

2016-05-22 10:40:14 [15726] [68] DEBUG:      data: 32 31 30 34 30 20 73 74 61 74 3a 53 45 45 4e 20   21040 stat:SEEN

2016-05-22 10:40:14 [15726] [68] DEBUG:      data: 65 72 72 3a 30 30 30 20 74 65 78 74 3a            err:000 text:

2016-05-22 10:40:14 [15726] [68] DEBUG:    Octet string dump ends.

2016-05-22 10:40:14 [15726] [68] DEBUG:   message_state: 2 = 0x00000002

2016-05-22 10:40:14 [15726] [68] DEBUG:   receipted_message_id:

2016-05-22 10:40:14 [15726] [68] DEBUG:    Octet string at 0x7f6b4c00bc10:

2016-05-22 10:40:14 [15726] [68] DEBUG:      len:  20

2016-05-22 10:40:14 [15726] [68] DEBUG:      size: 21

2016-05-22 10:40:14 [15726] [68] DEBUG:      immutable: 0

2016-05-22 10:40:14 [15726] [68] DEBUG:      data: 31 34 36 33 39 30 36 33 36 38 36 38 39 30 30 31   1463906368689001

2016-05-22 10:40:14 [15726] [68] DEBUG:      data: 34 31 30 33                                       4103

2016-05-22 10:40:14 [15726] [68] DEBUG:    Octet string dump ends.

2016-05-22 10:40:14 [15726] [68] DEBUG: SMPP PDU dump ends.

 

 

Did anyone have idea what is make kannel behave like that ?!

Reply | Threaded
Open this post in threaded view
|  
Report Content as Inappropriate

Re: Kannel logs Deliver_sm as receive_sm !

amalysh
Hi,

because your provider sending wrong esm_class for DLRs.

Thanks,
Alex

Am 27.06.2016 um 16:45 schrieb Ahmed Shabana <[hidden email]>:

Dears ,
 
I face strange issue with my Kannel with a new smsc  connection
 
Although the provider pack dlr properly as shown in below logs in Deliver_SM PDU but kannel bb access log show them as “Receive SMS “ !!
 
 
Kannel logs
2016-05-22 10:39:28 Sent SMS [SMSC:xxxx] [ACT:] [FID:14639063686890014103] [from:SMS] [to:20100xxxx] [msg:27:hellooooooo..xxx] [META:?smpp_resp?] [udh:0:]
2016-05-22 10:39:29 Receive SMS [SMSC:xxxx] [ACT:xxx_xx] [FID:14639063686890014103] [from:+20100xxxx] [to:...] [msg:112:id:14639063686890014103 sub:001 dlvrd:001 submit date:1605221039 done date:1605221039 stat:DELIVRD err:000 text:] [META:?smpp?] [udh:0:]
2016-05-22 10:40:14 Receive SMS [SMSC:xxxxx] [ACT:xxxxx] [FID:14639063686890014103] [from:+20100xxxx] [to:...] [msg:109:id:14639063686890014103 sub:001 dlvrd:001 submit date:1605221040 done date:1605221040 stat:SEEN err:000 text:] [META:?smpp?] [udh:0:]
 
 
PDU logs
 
2016-05-22 10:39:28 [15726] [68] DEBUG: SMPP PDU 0x7f6b4c00b8d0 dump:
2016-05-22 10:39:28 [15726] [68] DEBUG:   type_name: submit_sm
2016-05-22 10:39:28 [15726] [68] DEBUG:   command_id: 4 = 0x00000004
2016-05-22 10:39:28 [15726] [68] DEBUG:   command_status: 0 = 0x00000000
2016-05-22 10:39:28 [15726] [68] DEBUG:   sequence_number: 78 = 0x0000004e
2016-05-22 10:39:28 [15726] [68] DEBUG:   service_type: NULL
2016-05-22 10:39:28 [15726] [68] DEBUG:   source_addr_ton: 5 = 0x00000005
2016-05-22 10:39:28 [15726] [68] DEBUG:   source_addr_npi: 0 = 0x00000000
2016-05-22 10:39:28 [15726] [68] DEBUG:   source_addr: "SMS"
2016-05-22 10:39:28 [15726] [68] DEBUG:   dest_addr_ton: 1 = 0x00000001
2016-05-22 10:39:28 [15726] [68] DEBUG:   dest_addr_npi: 0 = 0x00000000
2016-05-22 10:39:28 [15726] [68] DEBUG:   destination_addr: "20100xxxx"
2016-05-22 10:39:28 [15726] [68] DEBUG:   esm_class: 3 = 0x00000003
2016-05-22 10:39:28 [15726] [68] DEBUG:   protocol_id: 0 = 0x00000000
2016-05-22 10:39:28 [15726] [68] DEBUG:   priority_flag: 0 = 0x00000000
2016-05-22 10:39:28 [15726] [68] DEBUG:   schedule_delivery_time: NULL
2016-05-22 10:39:28 [15726] [68] DEBUG:   validity_period: NULL
2016-05-22 10:39:28 [15726] [68] DEBUG:   registered_delivery: 17 = 0x00000011
2016-05-22 10:39:28 [15726] [68] DEBUG:   replace_if_present_flag: 0 = 0x00000000
2016-05-22 10:39:28 [15726] [68] DEBUG:   data_coding: 0 = 0x00000000
2016-05-22 10:39:28 [15726] [68] DEBUG:   sm_default_msg_id: 0 = 0x00000000
2016-05-22 10:39:28 [15726] [68] DEBUG:   sm_length: 27 = 0x0000001b
2016-05-22 10:39:28 [15726] [68] DEBUG:   short_message:
2016-05-22 10:39:28 [15726] [68] DEBUG:    Octet string at 0x7f6b4c000fc0:
2016-05-22 10:39:28 [15726] [68] DEBUG:      len:  27
2016-05-22 10:39:28 [15726] [68] DEBUG:      size: 28
2016-05-22 10:39:28 [15726] [68] DEBUG:      immutable: 0
2016-05-22 10:39:28 [15726] [68] DEBUG:      data: 68 65 6c 6c 6f 6f 6f 6f 6f 6f 6f 0d 0a 4c 69 6e   hellooooooo..Lin
2016-05-22 10:39:28 [15726] [68] DEBUG:      .
2016-05-22 10:39:28 [15726] [68] DEBUG:      .
2016-05-22 10:39:28 [15726] [68] DEBUG:    Octet string dump ends.
2016-05-22 10:39:28 [15726] [68] DEBUG: SMPP PDU dump ends.
2016-05-22 10:39:28 [15726] [68] DEBUG: SMPP[xxxx]: throughput (1.00,0.00)
2016-05-22 10:39:28 [15726] [68] DEBUG: SMPP[xxxx]: throughput (1.00,0.00)
2016-05-22 10:39:28 [15726] [68] DEBUG: SMPP[xxxx]: Got PDU:
2016-05-22 10:39:28 [15726] [68] DEBUG: SMPP PDU 0x7f6b4c00b8d0 dump:
2016-05-22 10:39:28 [15726] [68] DEBUG:   type_name: submit_sm_resp
2016-05-22 10:39:28 [15726] [68] DEBUG:   command_id: 2147483652 = 0x80000004
2016-05-22 10:39:28 [15726] [68] DEBUG:   command_status: 0 = 0x00000000
2016-05-22 10:39:28 [15726] [68] DEBUG:   sequence_number: 78 = 0x0000004e
2016-05-22 10:39:28 [15726] [68] DEBUG:   message_id:
2016-05-22 10:39:28 [15726] [68] DEBUG:    Octet string at 0x7f6b4c000d30:
2016-05-22 10:39:28 [15726] [68] DEBUG:      len:  20
2016-05-22 10:39:28 [15726] [68] DEBUG:      size: 21
2016-05-22 10:39:28 [15726] [68] DEBUG:      immutable: 0
2016-05-22 10:39:28 [15726] [68] DEBUG:      data: 31 34 36 33 39 30 36 33 36 38 36 38 39 30 30 31   1463906368689001
2016-05-22 10:39:28 [15726] [68] DEBUG:      data: 34 31 30 33                                       4103
2016-05-22 10:39:28 [15726] [68] DEBUG:    Octet string dump ends.
2016-05-22 10:39:28 [15726] [68] DEBUG: SMPP PDU dump ends.
2016-05-22 10:39:28 [15726] [68] DEBUG: DLR[mysql]: Adding DLR smsc=xxxx, ts=14639063686890014103, src=SMS, dst=201003441970, mask=7, boxc=kannel5
2016-05-22 10:39:28 [15726] [68] DEBUG: adding DLR entry into database
2016-05-22 10:39:28 [15726] [68] DEBUG: sql: INSERT INTO `dlr3` (`smsc`, `ts`, `source`, `destination`, `service`, `url`, `mask`, `boxc`, `status`) VALUES (?, ?, ?, ?, ?, ?, ?, ?, 0)
2016-05-22 10:39:28 [15726] [68] DEBUG: SMPP[xxxxx]: throughput (1.00,0.00)
-----------
2016-05-22 10:39:29 [15726] [68] DEBUG:   type_name: deliver_sm
2016-05-22 10:39:29 [15726] [68] DEBUG:   command_id: 5 = 0x00000005
2016-05-22 10:39:29 [15726] [68] DEBUG:   command_status: 0 = 0x00000000
2016-05-22 10:39:29 [15726] [68] DEBUG:   sequence_number: 2 = 0x00000002
2016-05-22 10:39:29 [15726] [68] DEBUG:   service_type: NULL
2016-05-22 10:39:29 [15726] [68] DEBUG:   source_addr_ton: 1 = 0x00000001
2016-05-22 10:39:29 [15726] [68] DEBUG:   source_addr_npi: 1 = 0x00000001
2016-05-22 10:39:29 [15726] [68] DEBUG:   source_addr: "2010xxxx"
2016-05-22 10:39:29 [15726] [68] DEBUG:   dest_addr_ton: 5 = 0x00000005
2016-05-22 10:39:29 [15726] [68] DEBUG:   dest_addr_npi: 0 = 0x00000000
2016-05-22 10:39:29 [15726] [68] DEBUG:   destination_addr: "..."
2016-05-22 10:39:29 [15726] [68] DEBUG:   esm_class: 0 = 0x00000000
2016-05-22 10:39:29 [15726] [68] DEBUG:   protocol_id: 0 = 0x00000000
2016-05-22 10:39:29 [15726] [68] DEBUG:   priority_flag: 0 = 0x00000000
2016-05-22 10:39:29 [15726] [68] DEBUG:   schedule_delivery_time: NULL
2016-05-22 10:39:29 [15726] [68] DEBUG:   validity_period: NULL
2016-05-22 10:39:29 [15726] [68] DEBUG:   registered_delivery: 0 = 0x00000000
2016-05-22 10:39:29 [15726] [68] DEBUG:   replace_if_present_flag: 0 = 0x00000000
2016-05-22 10:39:29 [15726] [68] DEBUG:   data_coding: 0 = 0x00000000
2016-05-22 10:39:29 [15726] [68] DEBUG:   sm_default_msg_id: 0 = 0x00000000
2016-05-22 10:39:29 [15726] [68] DEBUG:   sm_length: 112 = 0x00000070
2016-05-22 10:39:29 [15726] [68] DEBUG:   short_message:
2016-05-22 10:39:29 [15726] [68] DEBUG:    Octet string at 0x7f6b4c000f40:
2016-05-22 10:39:29 [15726] [68] DEBUG:      len:  112
2016-05-22 10:39:29 [15726] [68] DEBUG:      size: 113
2016-05-22 10:39:29 [15726] [68] DEBUG:      immutable: 0
2016-05-22 10:39:29 [15726] [68] DEBUG:      data: 69 64 3a 31 34 36 33 39 30 36 33 36 38 36 38 39   id:1463906368689
2016-05-22 10:39:29 [15726] [68] DEBUG:      data: 30 30 31 34 31 30 33 20 73 75 62 3a 30 30 31 20   0014103 sub:001
2016-05-22 10:39:29 [15726] [68] DEBUG:      data: 64 6c 76 72 64 3a 30 30 31 20 73 75 62 6d 69 74   dlvrd:001 submit
2016-05-22 10:39:29 [15726] [68] DEBUG:      data: 20 64 61 74 65 3a 31 36 30 35 32 32 31 30 33 39    date:1605221039
2016-05-22 10:39:29 [15726] [68] DEBUG:      data: 20 64 6f 6e 65 20 64 61 74 65 3a 31 36 30 35 32    done date:16052
2016-05-22 10:39:29 [15726] [68] DEBUG:      data: 32 31 30 33 39 20 73 74 61 74 3a 44 45 4c 49 56   21039 stat:DELIV
2016-05-22 10:39:29 [15726] [68] DEBUG:      data: 52 44 20 65 72 72 3a 30 30 30 20 74 65 78 74 3a   RD err:000 text:
2016-05-22 10:39:29 [15726] [68] DEBUG:    Octet string dump ends.
2016-05-22 10:39:29 [15726] [68] DEBUG:   message_state: 2 = 0x00000002
2016-05-22 10:39:29 [15726] [68] DEBUG:   receipted_message_id:
2016-05-22 10:39:29 [15726] [68] DEBUG:    Octet string at 0x7f6b4c00b9a0:
2016-05-22 10:39:29 [15726] [68] DEBUG:      len:  20
2016-05-22 10:39:29 [15726] [68] DEBUG:      size: 21
2016-05-22 10:39:29 [15726] [68] DEBUG:      immutable: 0
2016-05-22 10:39:29 [15726] [68] DEBUG:      data: 31 34 36 33 39 30 36 33 36 38 36 38 39 30 30 31   1463906368689001
2016-05-22 10:39:29 [15726] [68] DEBUG:      data: 34 31 30 33                                       4103
2016-05-22 10:39:29 [15726] [68] DEBUG:    Octet string dump ends.
2016-05-22 10:39:29 [15726] [68] DEBUG: SMPP PDU dump ends.
 
 
2016-05-22 10:40:14 [15726] [68] DEBUG: SMPP PDU 0x7f6b4c00c530 dump:
2016-05-22 10:40:14 [15726] [68] DEBUG:   type_name: deliver_sm
2016-05-22 10:40:14 [15726] [68] DEBUG:   command_id: 5 = 0x00000005
2016-05-22 10:40:14 [15726] [68] DEBUG:   command_status: 0 = 0x00000000
2016-05-22 10:40:14 [15726] [68] DEBUG:   sequence_number: 3 = 0x00000003
2016-05-22 10:40:14 [15726] [68] DEBUG:   service_type: NULL
2016-05-22 10:40:14 [15726] [68] DEBUG:   source_addr_ton: 1 = 0x00000001
2016-05-22 10:40:14 [15726] [68] DEBUG:   source_addr_npi: 1 = 0x00000001
2016-05-22 10:40:14 [15726] [68] DEBUG:   source_addr: "201003441970"
2016-05-22 10:40:14 [15726] [68] DEBUG:   dest_addr_ton: 5 = 0x00000005
2016-05-22 10:40:14 [15726] [68] DEBUG:   dest_addr_npi: 0 = 0x00000000
2016-05-22 10:40:14 [15726] [68] DEBUG:   destination_addr: "..."
2016-05-22 10:40:14 [15726] [68] DEBUG:   esm_class: 0 = 0x00000000
2016-05-22 10:40:14 [15726] [68] DEBUG:   protocol_id: 0 = 0x00000000
2016-05-22 10:40:14 [15726] [68] DEBUG:   priority_flag: 0 = 0x00000000
2016-05-22 10:40:14 [15726] [68] DEBUG:   schedule_delivery_time: NULL
2016-05-22 10:40:14 [15726] [68] DEBUG:   validity_period: NULL
2016-05-22 10:40:14 [15726] [68] DEBUG:   registered_delivery: 0 = 0x00000000
2016-05-22 10:40:14 [15726] [68] DEBUG:   replace_if_present_flag: 0 = 0x00000000
2016-05-22 10:40:14 [15726] [68] DEBUG:   data_coding: 0 = 0x00000000
2016-05-22 10:40:14 [15726] [68] DEBUG:   sm_default_msg_id: 0 = 0x00000000
2016-05-22 10:40:14 [15726] [68] DEBUG:   sm_length: 109 = 0x0000006d
2016-05-22 10:40:14 [15726] [68] DEBUG:   short_message:
2016-05-22 10:40:14 [15726] [68] DEBUG:    Octet string at 0x7f6b4c00bb60:
2016-05-22 10:40:14 [15726] [68] DEBUG:      len:  109
2016-05-22 10:40:14 [15726] [68] DEBUG:      size: 110
2016-05-22 10:40:14 [15726] [68] DEBUG:      immutable: 0
2016-05-22 10:40:14 [15726] [68] DEBUG:      data: 69 64 3a 31 34 36 33 39 30 36 33 36 38 36 38 39   id:1463906368689
2016-05-22 10:40:14 [15726] [68] DEBUG:      data: 30 30 31 34 31 30 33 20 73 75 62 3a 30 30 31 20   0014103 sub:001
2016-05-22 10:40:14 [15726] [68] DEBUG:      data: 64 6c 76 72 64 3a 30 30 31 20 73 75 62 6d 69 74   dlvrd:001 submit
2016-05-22 10:40:14 [15726] [68] DEBUG:      data: 20 64 61 74 65 3a 31 36 30 35 32 32 31 30 34 30    date:1605221040
2016-05-22 10:40:14 [15726] [68] DEBUG:      data: 20 64 6f 6e 65 20 64 61 74 65 3a 31 36 30 35 32    done date:16052
2016-05-22 10:40:14 [15726] [68] DEBUG:      data: 32 31 30 34 30 20 73 74 61 74 3a 53 45 45 4e 20   21040 stat:SEEN
2016-05-22 10:40:14 [15726] [68] DEBUG:      data: 65 72 72 3a 30 30 30 20 74 65 78 74 3a            err:000 text:
2016-05-22 10:40:14 [15726] [68] DEBUG:    Octet string dump ends.
2016-05-22 10:40:14 [15726] [68] DEBUG:   message_state: 2 = 0x00000002
2016-05-22 10:40:14 [15726] [68] DEBUG:   receipted_message_id:
2016-05-22 10:40:14 [15726] [68] DEBUG:    Octet string at 0x7f6b4c00bc10:
2016-05-22 10:40:14 [15726] [68] DEBUG:      len:  20
2016-05-22 10:40:14 [15726] [68] DEBUG:      size: 21
2016-05-22 10:40:14 [15726] [68] DEBUG:      immutable: 0
2016-05-22 10:40:14 [15726] [68] DEBUG:      data: 31 34 36 33 39 30 36 33 36 38 36 38 39 30 30 31   1463906368689001
2016-05-22 10:40:14 [15726] [68] DEBUG:      data: 34 31 30 33                                       4103
2016-05-22 10:40:14 [15726] [68] DEBUG:    Octet string dump ends.
2016-05-22 10:40:14 [15726] [68] DEBUG: SMPP PDU dump ends.
 
 
Did anyone have idea what is make kannel behave like that ?!

Loading...