New issue

Have a question about this project? Sign up for a free GitHub account to open an issue and contact its maintainers and the community.

By clicking “Sign up for GitHub”, you agree to our terms of service and privacy statement. We’ll occasionally send you account related emails.

Already on GitHub? Sign in to your account

Timeout while retrieving messages (Samsung B2100) #317

Open
nicolashainaux opened this Issue Jun 21, 2017 · 0 comments

Comments

Projects
None yet
1 participant
@nicolashainaux

nicolashainaux commented Jun 21, 2017

This looks similar to #253 but I'm not so sure, because error messages look a bit different

I used Wammu and a B2100. It happens when retrieving the messages. There is not a lot of them, but retrieving them lasts a long time and when it was close to the end, it ended with the timeout error.

The log file is huge (1.9 Mb) and I don't know exactly what parts are relevant (nor what parts are my private messages). Moreover, strangely, the very last lines do not show any error.

Spotted errors (at the end there's also an unknown frame, and it is asked to report it):

$ grep -i error wammu.log 
Tue 2017/06/20 19:33:11: 2 "+CME ERROR: 3"
Tue 2017/06/20 19:33:11: Checking line: +CME ERROR: 3
Tue 2017/06/20 19:33:11: 20 |45E|52R|52R|4FO|52R|3A:|20 |333|0D |0A                       ERROR: 3..     
Tue 2017/06/20 19:33:11: CME Error 3: "operation not allowed"
Tue 2017/06/20 19:33:11: Enabling CME errors
[repeated several times]
Tue 2017/06/20 19:33:14: GSM_SetIncomingCall failed with error SECURITYERROR[23]: Erreur de sécurité : le code PIN est-il correct ?
[again CME Error 3]
Tue 2017/06/20 19:33:25: Application data received: m-obex error="0"
Tue 2017/06/20 19:33:25: Application data received: m-obex error="2"
["0" and "2" errors again a lot of times]
Tue 2017/06/20 19:34:48: GSM_GetOriginalIMEI failed with error NOTSUPPORTED[21]: Fonctionnalités non supportées par votre téléphone.
Tue 2017/06/20 19:34:48: GSM_GetHardware failed with error NOTSUPPORTED[21]: Fonctionnalités non supportées par votre téléphone.
Tue 2017/06/20 19:34:48: GSM_GetManufactureMonth failed with error NOTSUPPORTED[21]: Fonctionnalités non supportées par votre téléphone.
Tue 2017/06/20 19:34:48: GSM_GetPPM failed with error NOTSUPPORTED[21]: Fonctionnalités non supportées par votre téléphone.
Tue 2017/06/20 19:43:55: Application data received: m-obex error="0" Timestamp="J"
[again a lot of times]
Tue 2017/06/20 19:51:01: 2 "+CMS ERROR: 321"
Tue 2017/06/20 19:51:01: Checking line: +CMS ERROR: 321
Tue 2017/06/20 19:51:01: 53S|20 |45E|52R|52R|4FO|52R|3A:|20 |333|322|311|0D |0A          S ERROR: 321..  
Tue 2017/06/20 19:51:01: CMS Error 321: "invalid memory index"
[again a lot of times]
Tue 2017/06/20 20:00:03: UNKNOWN frame. Please report the error, see <https://wammu.eu/support/bugs/>. Thank you
Tue 2017/06/20 20:03:22: GSM_GetNextSMS failed with error TIMEOUT[14]: Aucune réponse dans le temps d'attente spécifié: Le téléphone n'est peut-être pas connecté.

Here is the start of the log file:

--------------- System information ----------------
Platform     linux2
Python       2.7.13
wxPython     3.0.2.0
Wammu        0.43
python-gammu 2.8
Gammu        1.38.3
Bluetooth    None
locales      fr_FR (UTF-8)
connection   at115200
device       /dev/ttyACM0
model        
Tue 2017/06/20 19:33:09: [Gammu            - 1.38.3]
Tue 2017/06/20 19:33:09: [Connection       - "at115200"]
Tue 2017/06/20 19:33:09: [Connection index - 0]
Tue 2017/06/20 19:33:09: [Model type       - ""]
Tue 2017/06/20 19:33:09: [Device           - "/dev/ttyACM0"]
Tue 2017/06/20 19:33:09: [Running on       - Linux, kernel 4.9.33-1-MANJARO (#1 SMP PREEMPT Sat Jun 17 14:07:44 UTC 2017)]
Tue 2017/06/20 19:33:09: Serial device: DTR is up, RTS is up, CAR is down, CTS is up
Tue 2017/06/20 19:33:09: Setting speed to 115200
Tue 2017/06/20 19:33:09: [Module           - "auto"]
Tue 2017/06/20 19:33:09: Escaping SMS mode
Tue 2017/06/20 19:33:09: SENDING frame type 0x00/length 0x02/2
Tue 2017/06/20 19:33:09: 1B |0D                                                          ..              
Tue 2017/06/20 19:33:10: Sending simple AT command to wake up some devices
Tue 2017/06/20 19:33:10: SENDING frame type 0x00/length 0x03/3
Tue 2017/06/20 19:33:10: 41A|54T|0D                                                      AT.             
Tue 2017/06/20 19:33:10: 1 "OK"
Tue 2017/06/20 19:33:10: Checking line: OK
Tue 2017/06/20 19:33:10: AT reply state: 1
Tue 2017/06/20 19:33:10: RECEIVED frame type 0x00/length 0x04/4
Tue 2017/06/20 19:33:10: 4FO|4BK|0D |0A                                                  OK..            
Tue 2017/06/20 19:33:10: Enabling echo
Tue 2017/06/20 19:33:10: SENDING frame type 0x00/length 0x05/5
Tue 2017/06/20 19:33:10: 41A|54T|45E|311|0D                                              ATE1.           
Tue 2017/06/20 19:33:10: 1 "OK"
Tue 2017/06/20 19:33:10: Checking line: OK
Tue 2017/06/20 19:33:10: AT reply state: 1
Tue 2017/06/20 19:33:10: RECEIVED frame type 0x00/length 0x04/4
Tue 2017/06/20 19:33:10: 4FO|4BK|0D |0A                                                  OK..            
Tue 2017/06/20 19:33:10: Trying Motorola mode switch
Tue 2017/06/20 19:33:10: SENDING frame type 0x00/length 0x0A/10
Tue 2017/06/20 19:33:10: 41A|54T|2B+|4DM|4FO|44D|45E|3D=|322|0D                          AT+MODE=2.      
Tue 2017/06/20 19:33:11: 1 "AT+MODE=2"
Tue 2017/06/20 19:33:11: 2 "+CME ERROR: 3"
Tue 2017/06/20 19:33:11: Checking line: +CME ERROR: 3
Tue 2017/06/20 19:33:11: AT reply state: 6
Tue 2017/06/20 19:33:11: RECEIVED frame type 0x00/length 0x1B/27
Tue 2017/06/20 19:33:11: 41A|54T|2B+|4DM|4FO|44D|45E|3D=|322|0D |0D |0A |2B+|43C|4DM|45E AT+MODE=2...+CME
Tue 2017/06/20 19:33:11: 20 |45E|52R|52R|4FO|52R|3A:|20 |333|0D |0A                       ERROR: 3..     
Tue 2017/06/20 19:33:11: CME Error 3: "operation not allowed"
Tue 2017/06/20 19:33:11: Seems not to be supported
Tue 2017/06/20 19:33:11: Enabling CME errors
Tue 2017/06/20 19:33:11: SENDING frame type 0x00/length 0x0A/10
Tue 2017/06/20 19:33:11: 41A|54T|2B+|43C|4DM|45E|45E|3D=|311|0D                          AT+CMEE=1.      
Tue 2017/06/20 19:33:11: 1 "AT+CMEE=1"
Tue 2017/06/20 19:33:11: 2 "OK"
Tue 2017/06/20 19:33:11: Checking line: OK
Tue 2017/06/20 19:33:11: AT reply state: 1
Tue 2017/06/20 19:33:11: RECEIVED frame type 0x00/length 0x10/16
Tue 2017/06/20 19:33:11: 41A|54T|2B+|43C|4DM|45E|45E|3D=|311|0D |0D |0A |4FO|4BK|0D |0A  AT+CMEE=1...OK..
Tue 2017/06/20 19:33:11: SENDING frame type 0x00/length 0x09/9
Tue 2017/06/20 19:33:11: 41A|54T|2B+|43C|53S|43C|53S|3F?|0D                              AT+CSCS?.       
Tue 2017/06/20 19:33:12: 1 "AT+CSCS?"
Tue 2017/06/20 19:33:12: 2 "+CSCS: "GSM""
Tue 2017/06/20 19:33:12: 3 "OK"
Tue 2017/06/20 19:33:12: Checking line: OK
Tue 2017/06/20 19:33:12: AT reply state: 1
Tue 2017/06/20 19:33:12: RECEIVED frame type 0x00/length 0x1F/31
Tue 2017/06/20 19:33:12: 41A|54T|2B+|43C|53S|43C|53S|3F?|0D |0D |0A |2B+|43C|53S|43C|53S AT+CSCS?...+CSCS
Tue 2017/06/20 19:33:12: 3A:|20 |22"|47G|53S|4DM|22"|0D |0A |0D |0A |4FO|4BK|0D |0A      : "GSM"....OK.. 
Tue 2017/06/20 19:33:12: SENDING frame type 0x00/length 0x0A/10
Tue 2017/06/20 19:33:12: 41A|54T|2B+|43C|53S|43C|53S|3D=|3F?|0D                          AT+CSCS=?.      
Tue 2017/06/20 19:33:12: 1 "AT+CSCS=?"
Tue 2017/06/20 19:33:12: 2 "+CSCS: ("GSM","UCS2""UTF-8")"
Tue 2017/06/20 19:33:12: 3 "OK"
Tue 2017/06/20 19:33:12: Checking line: OK
Tue 2017/06/20 19:33:12: AT reply state: 1
Tue 2017/06/20 19:33:12: RECEIVED frame type 0x00/length 0x30/48
Tue 2017/06/20 19:33:12: 41A|54T|2B+|43C|53S|43C|53S|3D=|3F?|0D |0D |0A |2B+|43C|53S|43C AT+CSCS=?...+CSC
Tue 2017/06/20 19:33:12: 53S|3A:|20 |28(|22"|47G|53S|4DM|22"|2C,|22"|55U|43C|53S|322|22" S: ("GSM","UCS2"
Tue 2017/06/20 19:33:12: 22"|55U|54T|46F|2D-|388|22"|29)|0D |0A |0D |0A |4FO|4BK|0D |0A  "UTF-8")....OK..
Tue 2017/06/20 19:33:12: Chosen GSM as normal charset
Tue 2017/06/20 19:33:12: Chosen UTF-8 as unicode charset
Tue 2017/06/20 19:33:12: Getting model
Tue 2017/06/20 19:33:12: SENDING frame type 0x00/length 0x08/8
Tue 2017/06/20 19:33:12: 41A|54T|2B+|43C|47G|4DM|4DM|0D                                  AT+CGMM.        
Tue 2017/06/20 19:33:12: 1 "AT+CGMM"
Tue 2017/06/20 19:33:12: 2 "SAMSUNG B2100"
Tue 2017/06/20 19:33:12: 3 "OK"
Tue 2017/06/20 19:33:12: Checking line: OK
Tue 2017/06/20 19:33:12: AT reply state: 1
Tue 2017/06/20 19:33:12: RECEIVED frame type 0x00/length 0x1F/31
Tue 2017/06/20 19:33:12: 41A|54T|2B+|43C|47G|4DM|4DM|0D |0D |0A |53S|41A|4DM|53S|55U|4EN AT+CGMM...SAMSUN
Tue 2017/06/20 19:33:12: 47G|20 |42B|322|311|300|300|0D |0A |0D |0A |4FO|4BK|0D |0A      G B2100....OK.. 
Tue 2017/06/20 19:33:12: [Model name: `SAMSUNG B2100']
Tue 2017/06/20 19:33:12: [Model data: `SAMSUNG B2100']
Tue 2017/06/20 19:33:12: [Model data: `B2100']
Tue 2017/06/20 19:33:12: [Connected model  - "SAMSUNG B2100"]
Tue 2017/06/20 19:33:12: SENDING frame type 0x00/length 0x08/8
Tue 2017/06/20 19:33:12: 41A|54T|2B+|43C|47G|4DM|49I|0D                                  AT+CGMI.        
Tue 2017/06/20 19:33:12: 1 "AT+CGMI"
Tue 2017/06/20 19:33:12: 2 "SAMSUNG"
Tue 2017/06/20 19:33:12: 3 "OK"
Tue 2017/06/20 19:33:12: Checking line: OK
Tue 2017/06/20 19:33:12: AT reply state: 1
Tue 2017/06/20 19:33:12: RECEIVED frame type 0x00/length 0x19/25
Tue 2017/06/20 19:33:12: 41A|54T|2B+|43C|47G|4DM|49I|0D |0D |0A |53S|41A|4DM|53S|55U|4EN AT+CGMI...SAMSUN
Tue 2017/06/20 19:33:12: 47G|0D |0A |0D |0A |4FO|4BK|0D |0A                              G....OK..       
Tue 2017/06/20 19:33:12: Manufacturer info received
Tue 2017/06/20 19:33:12: [Manufacturer: Samsung]
Tue 2017/06/20 19:33:12: Checking for OBEX support
Tue 2017/06/20 19:33:12: SENDING frame type 0x00/length 0x0B/11
Tue 2017/06/20 19:33:12: 41A|54T|2B+|43C|50P|52R|4FO|54T|3D=|3F?|0D                      AT+CPROT=?.     
Tue 2017/06/20 19:33:12: 1 "AT+CPROT=?"
Tue 2017/06/20 19:33:12: 2 "+CPROT: 0,"1.0",8"
Tue 2017/06/20 19:33:12: 3 "OK"
Tue 2017/06/20 19:33:12: Checking line: OK
Tue 2017/06/20 19:33:12: AT reply state: 1
Tue 2017/06/20 19:33:12: RECEIVED frame type 0x00/length 0x26/38
Tue 2017/06/20 19:33:12: 41A|54T|2B+|43C|50P|52R|4FO|54T|3D=|3F?|0D |0D |0A |2B+|43C|50P AT+CPROT=?...+CP
Tue 2017/06/20 19:33:12: 52R|4FO|54T|3A:|20 |300|2C,|22"|311|2E.|300|22"|2C,|388|0D |0A  ROT: 0,"1.0",8..
Tue 2017/06/20 19:33:12: 0D |0A |4FO|4BK|0D |0A                                          ..OK..          
Tue 2017/06/20 19:33:12: Protocol entries received
Tue 2017/06/20 19:33:12: Parsing +CPROT: 0,"1.0",8 with +CPROT: (@i), (@r), (@i)
Tue 2017/06/20 19:33:12: Parsing +CPROT: 0,"1.0",8 with +CPROT: @i, @r, @i
Tue 2017/06/20 19:33:12: Parsed int 0
Tue 2017/06/20 19:33:12: Grabbed string from reply: "1.0" (parsed 5 bytes)
Tue 2017/06/20 19:33:12: Parsed raw string "1.0"
Tue 2017/06/20 19:33:12: Parsed int 8
Tue 2017/06/20 19:33:12: OBEX seems to be supported, version 1.0, level 8!
Tue 2017/06/20 19:33:12: [Module           - "sonyericsson|ericsson|atobex"]
Tue 2017/06/20 19:33:12: Escaping SMS mode
Tue 2017/06/20 19:33:12: SENDING frame type 0x00/length 0x02/2
Tue 2017/06/20 19:33:12: 1B |0D                                                          ..              
Tue 2017/06/20 19:33:12: Sending simple AT command to wake up some devices
Tue 2017/06/20 19:33:12: SENDING frame type 0x00/length 0x03/3
Tue 2017/06/20 19:33:12: 41A|54T|0D                                                      AT.             
Tue 2017/06/20 19:33:12: 1 "AT"
Tue 2017/06/20 19:33:12: 2 "OK"
Tue 2017/06/20 19:33:12: Checking line: OK
Tue 2017/06/20 19:33:12: AT reply state: 1
Tue 2017/06/20 19:33:12: RECEIVED frame type 0x00/length 0x09/9
Tue 2017/06/20 19:33:12: 41A|54T|0D |0D |0A |4FO|4BK|0D |0A                              AT...OK..       
Tue 2017/06/20 19:33:12: Enabling echo
Tue 2017/06/20 19:33:12: SENDING frame type 0x00/length 0x05/5
Tue 2017/06/20 19:33:12: 41A|54T|45E|311|0D                                              ATE1.           
Tue 2017/06/20 19:33:12: 1 "ATE1"
Tue 2017/06/20 19:33:12: 2 "OK"
Tue 2017/06/20 19:33:12: Checking line: OK
Tue 2017/06/20 19:33:12: AT reply state: 1
Tue 2017/06/20 19:33:12: RECEIVED frame type 0x00/length 0x0B/11
Tue 2017/06/20 19:33:12: 41A|54T|45E|311|0D |0D |0A |4FO|4BK|0D |0A                      ATE1...OK..     
Tue 2017/06/20 19:33:12: Trying Motorola mode switch
Tue 2017/06/20 19:33:12: SENDING frame type 0x00/length 0x0A/10
Tue 2017/06/20 19:33:12: 41A|54T|2B+|4DM|4FO|44D|45E|3D=|322|0D                          AT+MODE=2.      
Tue 2017/06/20 19:33:12: 1 "AT+MODE=2"
Tue 2017/06/20 19:33:12: 2 "+CME ERROR: 3"
Tue 2017/06/20 19:33:12: Checking line: +CME ERROR: 3
Tue 2017/06/20 19:33:12: AT reply state: 6
Tue 2017/06/20 19:33:12: RECEIVED frame type 0x00/length 0x1B/27
Tue 2017/06/20 19:33:12: 41A|54T|2B+|4DM|4FO|44D|45E|3D=|322|0D |0D |0A |2B+|43C|4DM|45E AT+MODE=2...+CME
Tue 2017/06/20 19:33:12: 20 |45E|52R|52R|4FO|52R|3A:|20 |333|0D |0A                       ERROR: 3..     
Tue 2017/06/20 19:33:12: CME Error 3: "operation not allowed"
Tue 2017/06/20 19:33:12: Seems not to be supported
Tue 2017/06/20 19:33:12: Enabling CME errors
Tue 2017/06/20 19:33:12: SENDING frame type 0x00/length 0x0A/10
Tue 2017/06/20 19:33:12: 41A|54T|2B+|43C|4DM|45E|45E|3D=|311|0D                          AT+CMEE=1.      
Tue 2017/06/20 19:33:12: 1 "AT+CMEE=1"
Tue 2017/06/20 19:33:12: 2 "OK"

Here the last lines:

Tue 2017/06/20 20:04:53: Entering GSM_GetBatteryCharge
Tue 2017/06/20 20:04:53: Getting battery charge
Tue 2017/06/20 20:04:53: SENDING frame type 0x00/length 0x07/7
Tue 2017/06/20 20:04:53: 41A|54T|2B+|43C|42B|43C|0D                                      AT+CBC.         
Tue 2017/06/20 20:04:54: 1 "AT+CBC"
Tue 2017/06/20 20:04:54: 2 "+CBC: 0,125"
Tue 2017/06/20 20:04:54: 3 "OK"
Tue 2017/06/20 20:04:54: Checking line: OK
Tue 2017/06/20 20:04:54: AT reply state: 1
Tue 2017/06/20 20:04:54: RECEIVED frame type 0x00/length 0x1C/28
Tue 2017/06/20 20:04:54: 41A|54T|2B+|43C|42B|43C|0D |0D |0A |2B+|43C|42B|43C|3A:|20 |300 AT+CBC...+CBC: 0
Tue 2017/06/20 20:04:54: 2C,|311|322|355|0D |0A |0D |0A |4FO|4BK|0D |0A                  ,125....OK..    
Tue 2017/06/20 20:04:54: Battery level received
Tue 2017/06/20 20:04:54: Parsing +CBC: 0,125 with +CBC: @i, @i
Tue 2017/06/20 20:04:54: Parsed int 0
Tue 2017/06/20 20:04:54: Parsed int 125
Tue 2017/06/20 20:04:54: Leaving GSM_GetBatteryCharge
Tue 2017/06/20 20:04:54: Entering GSM_GetDateTime
Tue 2017/06/20 20:04:54: Getting date & time
Tue 2017/06/20 20:04:54: SENDING frame type 0x00/length 0x09/9
Tue 2017/06/20 20:04:54: 41A|54T|2B+|43C|43C|4CL|4BK|3F?|0D                              AT+CCLK?.       
Tue 2017/06/20 20:04:54: 1 "AT+CCLK?"
Tue 2017/06/20 20:04:54: 2 "+CCLK: "17/06/20,20:04:52+00""
Tue 2017/06/20 20:04:54: 3 "OK"
Tue 2017/06/20 20:04:54: Checking line: OK
Tue 2017/06/20 20:04:54: AT reply state: 1
Tue 2017/06/20 20:04:54: RECEIVED frame type 0x00/length 0x30/48
Tue 2017/06/20 20:04:54: 41A|54T|2B+|43C|43C|4CL|4BK|3F?|0D |0D |0A |2B+|43C|43C|4CL|4BK AT+CCLK?...+CCLK
Tue 2017/06/20 20:04:54: 3A:|20 |22"|311|377|2F/|300|366|2F/|322|300|2C,|322|300|3A:|300 : "17/06/20,20:0
Tue 2017/06/20 20:04:54: 344|3A:|355|322|2B+|300|300|22"|0D |0A |0D |0A |4FO|4BK|0D |0A  4:52+00"....OK..
Tue 2017/06/20 20:04:54: Parsing +CCLK: "17/06/20,20:04:52+00" with +CCLK: @d
Tue 2017/06/20 20:04:54: Grabbed string from reply: "17/06/20,20:04:52+00" (parsed 22 bytes)
Tue 2017/06/20 20:04:54: Parsed string for date "17/06/20,20:04:52+00"
Tue 2017/06/20 20:04:54: Parsed date: 2017-6-20 20:4:52, TZ 0
Tue 2017/06/20 20:04:54: Leaving GSM_GetDateTime
Sign up for free to join this conversation on GitHub. Already have an account? Sign in to comment