From: Conor L. <cl...@dr...> - 2014-02-12 10:25:50
|
Hi, I have installed trousers-0.3.11.2 When I run tpm-luks-init I get an "Insufficient TPM resources" from tpm_nvdefine, so I enabled debug in trousers. I now see the following output from tpm_nvdefine: LOG_DEBUG TSPI tsp_tcsi_param.c:102 Got no value inside environment var TSS_TCSD_HOSTNAME. LOG_DEBUG TSPI tsp_tcsi_param.c:158 Hostname localhost will be used LOG_DEBUG TSPI obj_context.c:50 Hostname to be used by the context is localhost. LOG_DEBUG TSPI obj_context.c:202 context->machineName: localhost. LOG_DEBUG TSPI rpc/tcstp/rpc.c:480 Retrieving address information from host: localhost LOG_WARNING TSPI rpc/tcstp/rpc.c:490 WARNING: Got a list of valid IPs LOG_DEBUG TSPI rpc/tcstp/rpc_context.c:44 RPC_OpenContext_TP: Received TCS Context: 0xa0938800 LOG_DEBUG TSPI rpc/tcstp/rpc_caps_tpm.c:40 RPC_GetTPMCapability_TP: TCS Context: 0xa0938800 LOG_DEBUG TSPI rpc/tcstp/rpc_auth.c:70 RPC_OSAP_TP: TCS Context: 0xa0938800 LOG_DEBUG TSPI rpc/tcstp/rpc_nv.c:39 RPC_NV_DefineOrReleaseSpace_TP: TCS Context: 0xa0938800 LOG_DEBUG TSPI rpc/tcstp/rpc_nv.c:69 RPC_NV_DefineOrReleaseSpace_TP: result=21 Tspi_NV_DefineSpace failed: 0x00000015 - layer=tpm, code=0015 (21), Insufficient TPM resources LOG_DEBUG TSPI rpc/tcstp/rpc_context.c:60 RPC_CloseContext_TP: TCS Context: 0xa0938800 LOG_RETERR TSPI tspi_context.c:113: 0x126 I've made the following changes to tcs_utils.c replaced LogData("UnloadBlob_Tag:", (temp)); with LogDebug("UnloadBlob_Tag: %d", (temp)); replaced LogData("UnloadBlob_Header, size:", *size); with LogDebug("UnloadBlob_Header, size: %d", *size); replaced LogData("UnloadBlob_Header, returnCode:", Decode_UINT32(&blob[6])); with LogDebug("UnloadBlob_Header, returnCode: %d", Decode_UINT32(&blob[6])); I see the following output from tcsd TCSD svrside.c:539 accepted socket 6 TCSD svrside.c:514 Waiting for connections TCSD tcsd_threads.c:232 total_recv_size 28, buf_size 1024, recd_so_far 28 TCSD tcsd_threads.c:284 Rx'd packet TCSD TCS rpc/tcstp/rpc.c:581 Dispatching ordinal 1 (OpenContext) TCSD TCS rpc/tcstp/rpc_context.c:37 tcs_wrap_OpenContext: thread -1208972400 TCSD TCS rpc/tcstp/rpc_context.c:53 New context is 0xa093d601 TCSD tcsd_threads.c:313 Sending 0x26 bytes back TCSD tcsd_threads.c:232 total_recv_size 44, buf_size 1024, recd_so_far 28 TCSD tcsd_threads.c:277 recv_chunk_size 16 recd_so_far 28 TCSD tcsd_threads.c:284 Rx'd packet TCSD TCS rpc/tcstp/rpc.c:581 Dispatching ordinal 46 (GetCapability) TCSD TCS rpc/tcstp/rpc_caps_tpm.c:47 tcs_wrap_GetCapability: thread -1208972400d context a093d601 TCSD TCS tcsi_caps_tpm.c:43 Entering Get Cap To TPM: 00 C1 00 00 00 12 00 00 00 65 00 00 00 0D 00 00 To TPM: 00 00 TCSD TDDL tddl.c:171 Calling write to driver From TPM: 00 C4 00 00 00 36 00 00 00 00 00 00 00 28 10 00 From TPM: 00 01 10 00 F0 00 50 00 00 02 50 00 00 01 00 00 From TPM: 00 02 00 00 00 03 00 00 00 04 00 00 00 05 00 00 From TPM: 00 06 00 00 00 07 TCSD tcsd_threads.c:313 Sending 0x4A bytes back TCSD tcsd_threads.c:232 total_recv_size 62, buf_size 1024, recd_so_far 28 TCSD tcsd_threads.c:277 recv_chunk_size 34 recd_so_far 28 TCSD tcsd_threads.c:284 Rx'd packet TCSD TCS rpc/tcstp/rpc.c:581 Dispatching ordinal 24 (OSAP) TCSD TCS rpc/tcstp/rpc_auth.c:86 tcs_wrap_OSAP: thread -1208972400 context a093d601 TCSD TCS tcsi_auth.c:74 Entering OSAP To TPM: 00 C1 00 00 00 24 00 00 00 0B 00 02 00 00 00 00 To TPM: 30 FD 99 40 EB 6E 9C 10 AD F8 95 0D 24 9E FB D6 To TPM: 5A 93 2C FB TCSD TDDL tddl.c:171 Calling write to driver From TPM: 00 C4 00 00 00 36 00 00 00 00 00 BF 0B 30 B8 4E From TPM: 13 BF A8 BB 78 90 21 24 1C 3B 58 1B 5B F8 8A 61 From TPM: 47 E3 4F 41 56 6D 4F 5B 4F 1D 4B 4B 67 2A 1E 75 From TPM: E1 F2 EB 97 EF 75 TCSD TCS tcs_auth_mgr.c:383 added auth for TCS a093d601 TPM bf0b30 TCSD tcsd_threads.c:313 Sending 0x4B bytes back TCSD tcsd_threads.c:232 total_recv_size 177, buf_size 1024, recd_so_far 28 TCSD tcsd_threads.c:277 recv_chunk_size 149 recd_so_far 28 TCSD tcsd_threads.c:284 Rx'd packet TCSD TCS rpc/tcstp/rpc.c:581 Dispatching ordinal 87 (NVDefineOrReleaseSpace) TCSD TCS tcsi_nv.c:41 TCSP_NV_DefineOrReleaseSpace_Internal: Enter TCSD TCS tcsi_nv.c:54 req_mgr_submit_req (oldOffset=146) To TPM: 00 C2 00 00 00 92 00 00 00 CC 00 18 00 00 00 01 To TPM: 00 03 30 53 00 1F B3 7C 56 2C B8 88 30 2B 85 09 To TPM: 1D E2 6D A1 70 39 25 F2 19 82 00 03 00 00 00 1F To TPM: 00 00 00 00 00 00 00 00 00 00 00 00 00 00 00 00 To TPM: 00 00 00 00 00 17 00 04 00 04 00 00 00 00 00 00 To TPM: 20 69 9C 21 21 1D BA FA 0F EC F9 D7 90 4A 9B 64 To TPM: 95 41 69 40 37 00 BF 0B 30 A2 DB 26 4C FC 36 B9 To TPM: DB DE 76 64 14 4F 60 AF 84 C7 06 3C A3 00 E9 77 To TPM: 6D 2F 9C 48 1B EC 89 93 72 8F A4 F7 80 B7 BE 52 To TPM: AE 51 TCSD TDDL tddl.c:171 Calling write to driver From TPM: 00 C4 00 00 00 0A 00 00 00 15 LOG_RETERR TPM tcsi_nv.c:58: 0x15 TCSD TCS tcsi_nv.c:59 UnloadBlob (paramSize=10) result=21 TCSD TCS tcsi_nv.c:64 Leaving DefineSpace with result:21 To TPM: 00 C1 00 00 00 12 00 00 00 BA 00 BF 0B 30 00 00 To TPM: 00 02 TCSD TDDL tddl.c:171 Calling write to driver From TPM: 00 C4 00 00 00 0A 00 00 00 03 LOG_RETERR TPM tcsi_admin.c:464: 0x3 TCSD TCS tcs_auth_mgr.c:289 TPM_TerminateHandle returned 3 TCSD TCS tcs_auth_mgr.c:118 no threads need to be signaled. TCSD tcsd_threads.c:313 Sending 0x1C bytes back TCSD tcsd_threads.c:232 total_recv_size 33, buf_size 1024, recd_so_far 28 TCSD tcsd_threads.c:277 recv_chunk_size 5 recd_so_far 28 TCSD tcsd_threads.c:284 Rx'd packet TCSD TCS rpc/tcstp/rpc.c:581 Dispatching ordinal 2 (CloseContext) TCSD TCS rpc/tcstp/rpc_context.c:71 tcs_wrap_CloseContext: thread -1208972400 context a093d601 TCSD TCS tcsi_context.c:39 Closing context A093D601 TCSD TCS tcsi_context.c:51 Context A093D601 closed TCSD tcsd_threads.c:313 Sending 0x1C bytes back TCSD TCS rpc/tcstp/rpc.c:68 Socket connection closed. TCSD tcsd_threads.c:325 Thread exiting. I've also tried the latest source in the git repository and get the same error. The problem seems to be the 15 that is received in a message from the driver. I'm having a look at the specs at the moment, but I'm not familiar enough yet to know what is going on. Any ideas? Thanks, Conor |