求助：SIM卡怎么掉电了呢？

Question

这两天在学着调试Android的RIL模块，遇到这个问题，哪位大哥帮忙看看，小弟感激不尽！
我把LOG打出来了：
I/RIL     ( 1788): RIL : Test : Call the RIL_RadioFunctions *RIL_Init
I/RIL     ( 1788): Opening tty device /dev/s3c_serial1
I/RIL     ( 1788): RIL : Test : RIL_RadioFunctions *RIL_Init end!
I/RIL     ( 1788): RIL : Test : Call mainLoop!!!
I/RIL     ( 1788): RIL : Test : mainLoop fd = 8
D/AT      ( 1788): AT> ATE0Q0V1
D/AT      ( 1788): AT< ATE0Q0V1
D/AT      ( 1788): AT< OK
D/AT      ( 1788): AT> ATE0Q0V1
D/AT      ( 1788): AT< OK
D/AT      ( 1788): AT> ATS0=0
D/AT      ( 1788): AT< OK
D/AT      ( 1788): AT> AT+CMEE=1
D/AT      ( 1788): AT< OK
D/AT      ( 1788): AT> AT+CREG=2
D/AT      ( 1788): AT< OK
D/AT      ( 1788): AT> AT+CGREG=1
D/AT      ( 1788): AT< OK
D/AT      ( 1788): AT> AT+CCWA=1
D/AT      ( 1788): AT< OK
D/AT      ( 1788): AT> AT+CMOD=0
D/AT      ( 1788): AT< OK
D/AT      ( 1788): AT> AT+CMUT=0
D/AT      ( 1788): AT< OK
D/AT      ( 1788): AT> AT+CSSN=0,1
D/AT      ( 1788): AT< OK
D/AT      ( 1788): AT> AT+COLP=0
D/AT      ( 1788): AT< OK
D/AT      ( 1788): AT> AT+CSCS="HEX"
D/AT      ( 1788): AT< +CREG: 1,"247C","0FD2"
D/AT      ( 1788): AT< OK
D/AT      ( 1788): AT> AT+CUSD=1
D/AT      ( 1788): AT< OK
D/AT      ( 1788): AT> AT+CGEREP=1
D/AT      ( 1788): AT< OK
D/AT      ( 1788): AT> AT+CMGF=0
D/AT      ( 1788): AT< OK
D/AT      ( 1788): AT> AT+CFUN?
D/AT      ( 1788): AT< +CFUN: 1
D/AT      ( 1788): AT< OK
D/AT      ( 1788): AT> AT+CPIN?
D/AT      ( 1788): AT< +CPIN: READY
D/AT      ( 1788): AT< OK
D/AT      ( 1788): AT> AT+CSMS=0
D/AT      ( 1788): AT< +CSMS: 1,1,1
D/AT      ( 1788): AT< OK
D/AT      ( 1788): AT> AT+CNMI=1,2,2,1,1
D/AT      ( 1788): AT< ERROR
D/AT      ( 1788): AT< +CGREG: 1
I/PHONE   ( 1856): Network Mode set to 0
I/PHONE   ( 1856): Cdma Subscription set to 1
I/RILC    ( 1788): libril: new connection
I/RILC    ( 1788): RIL Daemon version: android reference-ril 1.0
I/RILJ    ( 1856): Connected to 'rild' socket
D/RILJ    ( 1856): Radio ON @ init; reset to OFF
D/RILJ    ( 1856): [0000]> REQUEST_SET_PREFERRED_NETWORK_TYPE : 0
D/RIL     ( 1788): onRequest: SET_PREFERRED_NETWORK_TYPE
D/RILJ    ( 1856): [0001]> RIL_REQUEST_CDMA_SET_SUBSCRIPTION : 1
D/RIL     ( 1788): onRequest: CDMA_SET_SUBSCRIPTION
D/RILJ    ( 1856): [0002]> RADIO_POWER
D/RIL     ( 1788): onRequest: RADIO_POWER
D/AT      ( 1788): AT> AT+CFUN=0
D/RILJ    ( 1856): [UNSL]< UNSOL_RESPONSE_RADIO_STATE_CHANGED RADIO_UNAVAILABLE
D/RILJ    ( 1856): [0000]< REQUEST_SET_PREFERRED_NETWORK_TYPE error: com.android.internal.telephony.CommandException: REQUEST_NOT_SUPPORTED
D/RILJ    ( 1856): [0001]< RIL_REQUEST_CDMA_SET_SUBSCRIPTION error: com.android.internal.telephony.CommandException: REQUEST_NOT_SUPPORTED
D/PHONE   ( 1856): mDoesRilSendMultipleCallRing=true
D/PHONE   ( 1856): mCallRingDelay=3000
W/GSM     ( 1856): Can't open /system/etc/voicemail-conf.xml
W/GSM     ( 1856): Can't open /system/etc/spn-conf.xml
D/GSM     ( 1856): [DSAC DEB] registerForPsRestrictedEnabled 
D/GSM     ( 1856): [DSAC DEB] registerForPsRestrictedDisabled 
D/GSM     ( 1856): [PdpConnection] DataConnection.clearSettings()
D/RILJ    ( 1856): [0003]> RIL_REQUEST_REPORT_STK_SERVICE_IS_RUNNING
D/STK     ( 1856): StkService: StkService: is running
D/STK     ( 1856): StkService: NEW sInstance
I/PHONE   ( 1856): Creating GSMPhone
D/RILJ    ( 1856): [0004]> GET_CURRENT_CALLS
E/GSM     ( 1856): Wrong network type: 0
E/GSM     ( 1856): Wrong network type: 0
D/GSM     ( 1856): Poll ServiceState done:  oldSS=[1 home null null null  Unknown CSS not supported 0 0RoamInd: 0DefRoamInd: 0] newSS=[1 home null null null  Unknown CSS not supported -1 -1RoamInd: -1DefRoamInd: -1] oldGprs=1 newGprs=1 oldType=unknown newType=unknown
D/GSM     ( 1856): GSMDataConnTrack handleMessage { what=12 when=61165 obj=android.os.AsyncResult@43c78c60 }
D/GSM     ( 1856): [GsmDataConnectionTracker] Radio is off and clean up all connection
D/GSM     ( 1856): [GsmDataConnectionTracker] Clean up connection due to radioTurnedOff
D/GSM     ( 1856): [GsmDataConnectionTracker] setState: DISCONNECTING
D/GSM     ( 1856): [PdpConnection] DataConnection.clearSettings()
D/GSM     ( 1856): [DataConnection] Stop poll NetStat
D/GSM     ( 1856): [GsmDataConnectionTracker] setState: IDLE
D/AT      ( 1788): AT< +CREG: 0
D/RILJ    ( 1856): [UNSL]< UNSOL_RESPONSE_NETWORK_STATE_CHANGED
D/AT      ( 1788): AT< +CGEV: ME DETACH 
D/AT      ( 1788): AT< +CGREG: 0
D/RILJ    ( 1856): [UNSL]< UNSOL_RESPONSE_NETWORK_STATE_CHANGED
D/GSM     ( 1856): GSMDataConnTrack handleMessage { what=19 when=61166 obj=android.os.AsyncResult@43c78fb0 }
D/GSM     ( 1856): [DataConnection] Stop poll NetStat
D/AT      ( 1788): AT< OK
D/RIL     ( 1788): onRequest: <unknown request>
D/RIL     ( 1788): onRequest: GET_CURRENT_CALLS
D/AT      ( 1788): AT> AT+CGACT?
D/RILB    ( 1856): Notifying: radio available
D/RILJ    ( 1856): [0005]> SCREEN_STATE: true
D/RILJ    ( 1856): [UNSL]< UNSOL_RESPONSE_RADIO_STATE_CHANGED RADIO_OFF
D/RILJ    ( 1856): [0002]< RADIO_POWER 
D/RILJ    ( 1856): [0003]< RIL_REQUEST_REPORT_STK_SERVICE_IS_RUNNING error: com.android.internal.telephony.CommandException: RADIO_NOT_AVAILABLE
D/RILJ    ( 1856): [0004]< GET_CURRENT_CALLS error: com.android.internal.telephony.CommandException: RADIO_NOT_AVAILABLE
D/GSM     ( 1856): GSMDataConnTrack handleMessage { what=22 when=61166 obj=android.os.AsyncResult@43c79100 }
D/AT      ( 1788): AT< OK
D/AT      ( 1788): AT> AT+CGDCONT?
D/AT      ( 1788): AT< OK
D/RIL     ( 1788): onRequest: SCREEN_STATE
D/RILJ    ( 1856): [UNSL]< UNSOL_DATA_CALL_LIST_CHANGED []
D/RILJ    ( 1856): [0005]< SCREEN_STATE error: com.android.internal.telephony.CommandException: RADIO_NOT_AVAILABLE
D/GSM     ( 1856): [GsmDataConnectionTracker] ***trySetupData due to roamingOff
D/GSM     ( 1856): [DSAC DEB] trySetupData with mIsPsRestricted=false
D/GSM     ( 1856): [GsmDataConnectionTracker] trySetupData: Not ready for data:  dataState=IDLE gprsState=1 sim=false UMTS=false phoneState=IDLE isDataAllowed=true dataEnabled=true roaming=false dataOnRoamingEnable=true ps restricted=false desiredPowerState=true MasterDataEnabled=true
D/GSM     ( 1856): [IccCard] Broadcasting intent ACTION_SIM_STATE_CHANGED NOT_READY reason null
E/GSM     ( 1856): Wrong network type: 0
E/GSM     ( 1856): Wrong network type: 0
D/GSM     ( 1856): Poll ServiceState done:  oldSS=[1 home null null null  Unknown CSS not supported -1 -1RoamInd: -1DefRoamInd: -1] newSS=[3 home null null null  Unknown CSS not supported -1 -1RoamInd: -1DefRoamInd: -1] oldGprs=1 newGprs=1 oldType=unknown newType=unknown
E/GSM     ( 1856): Wrong network type: 0
E/GSM     ( 1856): Wrong network type: 0
D/GSM     ( 1856): Poll ServiceState done:  oldSS=[3 home null null null  Unknown CSS not supported -1 -1RoamInd: -1DefRoamInd: -1] newSS=[3 home null null null  Unknown CSS not supported -1 -1RoamInd: -1DefRoamInd: -1] oldGprs=1 newGprs=1 oldType=unknown newType=unknown
D/RILJ    ( 1856): [0006]> RADIO_POWER
D/RIL     ( 1788): onRequest: RADIO_POWER
D/AT      ( 1788): AT> AT+CFUN=1
E/GSM     ( 1856): Wrong network type: 0
E/GSM     ( 1856): Wrong network type: 0
D/GSM     ( 1856): Poll ServiceState done:  oldSS=[3 home null null null  Unknown CSS not supported -1 -1RoamInd: -1DefRoamInd: -1] newSS=[3 home null null null  Unknown CSS not supported -1 -1RoamInd: -1DefRoamInd: -1] oldGprs=1 newGprs=1 oldType=unknown newType=unknown
D/GSM     ( 1856): GSMDataConnTrack handleMessage { what=3 when=62118 obj=android.os.AsyncResult@43c94498 }
D/RILJ    ( 1856): [0007]> BASEBAND_VERSION
D/RILJ    ( 1856): [0008]> GET_IMEI
D/RILJ    ( 1856): [0009]> GET_IMEISV
D/GSM     ( 1856): GSMDataConnTrack handleMessage { what=6 when=62181 obj=android.os.AsyncResult@43c95dc8 }
D/AT      ( 1788): AT< +CREG: 2
D/RILJ    ( 1856): [UNSL]< UNSOL_RESPONSE_NETWORK_STATE_CHANGED
E/GSM     ( 1856): Wrong network type: 0
E/GSM     ( 1856): Wrong network type: 0
D/GSM     ( 1856): Poll ServiceState done:  oldSS=[3 home null null null  Unknown CSS not supported -1 -1RoamInd: -1DefRoamInd: -1] newSS=[3 home null null null  Unknown CSS not supported -1 -1RoamInd: -1DefRoamInd: -1] oldGprs=1 newGprs=1 oldType=unknown newType=unknown
D/AT      ( 1788): AT< OK
D/AT      ( 1788): AT> AT+CPIN?
D/RILB    ( 1856): Notifying: Radio On
D/RILJ    ( 1856): [UNSL]< UNSOL_RESPONSE_RADIO_STATE_CHANGED SIM_NOT_READY
D/RILJ    ( 1856): [0010]> OPERATOR
D/RILJ    ( 1856): [0011]> GPRS_REGISTRATION_STATE
D/RILJ    ( 1856): [0012]> REGISTRATION_STATE
D/RILJ    ( 1856): [0013]> QUERY_NETWORK_SELECTION_MODE
D/RILJ    ( 1856): [0014]> GET_CURRENT_CALLS
D/AT      ( 1788): AT< +CME ERROR: 772
D/RIL     ( 1788): onRequest: BASEBAND_VERSION
D/RIL     ( 1788): onRequest: GET_IMEI
D/AT      ( 1788): AT> AT+CGSN

Answer 1

从来没做过这方面的东西，看log，似乎根本就没有连上过sim卡。D/RILJ ( 1856): [UNSL]< UNSOL_RESPONSE_RADIO_STATE_CHANGED RADIO_UNAVAILABLE
D/RILJ ( 1856): [0000]< REQUEST_SET_PREFERRED_NETWORK_TYPE error: com.android.internal.telephony.CommandException: REQUEST_NOT_SUPPORTED在这边的时候已经开始报错了。

Answer 2

所谓SIM卡掉电，是指SIM卡没找到吗？顺便，你们该不会是播思通讯的合作伙伴吧，因为RIL_REQUEST_REPORT_STK_SERVICE_IS_RUNNING 这玩意一看就是OMS的AP发的

Answer 3

现在没有这个问题了，我也不知道怎么搞的，估计是Modem初始化出了点问题。

Answer 4

我特好奇，你是在和播思通讯合作吗，因为我看那个LOG里有眼熟的东西。

Answer 5

没有啦！用的是S3C6410+SIM300
不过现在已经改了，要做TD的模组

Answer 6

很奇怪，怎么会出现我加的LOG呢。

Answer 7

楼主给详细说说如何实现调用RIL的？

Answer 8

我的qq：709699129.我们正在开发htc mini手机的android系统。遇到了这个问题。