硬件环境:devkit8500d
软件环境:dvsdk4.0.0.3
问题描述:
按照codecs-omap3530_4_00_00_00开发包的提示内容,我集成了jpegenc库的内容,并成功生成了x64P文件,arm端app调用时,能成功执行IMGENC1_create和IMGENC1_delete,但是在执行IMGENC1_control时,一直返回-1的错误,我arm端app代码如下:
Int main(Int argc, Char *argv[])
{
Engine_Handle hEngine;
IMGENC1_Handle hImg;
printf(" ----------------------- demo -4- start ------------------------ \n");
//初始化engine
CERuntime_init();
TraceUtil_start(ENGINE_NAME);
//创建和启动engine
hEngine = Engine_open(ENGINE_NAME, NULL, NULL);
if ( hEngine == NULL)
{
printf("Failed to open engine %s\n", ENGINE_NAME);
exit(-1);
}
else
{
printf("Success to open engine %s\n", ENGINE_NAME);
}
GT_set("*=01234567");
//创建算法
hImg = IMGENC1_create(hEngine, CODEC_NAME, NULL);
if ( hImg == NULL)
{
printf("Failed to create codec %s\n", CODEC_NAME);
exit (-1);
}
else
{
printf("Success to create codec %s\n", CODEC_NAME);
}
#if 1
IMGENC1_DynamicParams encDynParams;
IMGENC1_Status encStatus;
encDynParams.size = sizeof(IMGENC1_DynamicParams);
memset(&encStatus, 0, sizeof(IMGENC1_Status));
encStatus.size = sizeof(IMGENC1_Status);
int status = IMGENC1_control(hImg, XDM_GETVERSION, &encDynParams, &encStatus);
printf("status = %d\n", status);
#endif
#if 0
///////////////////////////////////////////////////////////////////////////////////////////////////////
//调用process
//new buf
int imageSize = 352*288*3/2;
XDM_BufDesc inBufs, outBufs;
XDAS_Int8* in_bufs[1], *out_bufs[1];
XDAS_Int32 in_bufs_size[1], out_bufs_size[1];
evaluate_param_t m_param;
//init param
m_param.base.size = sizeof(m_param);
m_param.width = 352;
m_param.pitch = m_param.width;
m_param.height = 288;
imageSize = m_param.pitch * m_param.height;
//init buf
in_bufs_size[0] = out_bufs_size[0] = imageSize;
inBufs.bufs = in_bufs;
inBufs.bufSizes = in_bufs_size;
inBufs.numBufs = 1;
outBufs.bufs = out_bufs;
outBufs.bufSizes = out_bufs_size;
outBufs.numBufs = 1;
in_bufs[0] = (XDAS_Int8*)Memory_contigAlloc(in_bufs_size[0], 16);
out_bufs[0] = (XDAS_Int8*)Memory_contigAlloc(out_bufs_size[0], 16);
memset(in_bufs[0], 128, in_bufs_size[0]);
memset(out_bufs[0], 255, out_bufs_size[0]);
IMGDEC_OutArgs outArgs;
outArgs.size = sizeof(outArgs);
//read file
readFile(SRC_FILE, in_bufs[0], imageSize * sizeof(unsigned char));
//调用算法处理
int ret = IMGDEC_process(hImg, &inBufs, &outBufs, (IMGDEC_InArgs *)&m_param, &outArgs);
printf("IMGDEC_process ret:%d\n\n\n\n", ret);
writeFile("./dst.gray", outBufs.bufs[0], imageSize * sizeof(unsigned char));
//free buf
Memory_contigFree(in_bufs[0], in_bufs_size[0]);
Memory_contigFree(out_bufs[0], out_bufs_size[0]);
///////////////////////////////////////////////////////////////////////////////////////////////////////
#endif
//移除算法
IMGENC1_delete(hImg);
hImg = NULL;
//关闭engine
Engine_close(hEngine);
TraceUtil_stop();
hEngine = NULL;
}
在终端中,我使用CE_DEBUG=2 选项来执行app,得到的跟踪内容如下:
CE_DEBUG=2 ./encode
----------------------- demo -4- start ------------------------
@0,891,114us: [+4 T:0x40020100] OG - Global_init> This program was built with the following packages:
@0,891,236us: [+4 T:0x40020100] OG - package gnu.targets.arm.rtsv5T (/opt/dvsdk_4_00_00_22/xdctools_3_16_03_36/packages/gnu/targets/arm/rtsv5T/) [1, 0, 0, 0]
@0,891,267us: [+4 T:0x40020100] OG - package ti.sdo.codecs.jpegenc (/opt/dvsdk_4_00_00_22/codecs-omap3530_4_00_00_00/packages/ti/sdo/codecs/jpegenc/) [1, 0, 0]
@0,891,297us: [+4 T:0x40020100] OG - package codecs.jpegenc (/home/eric/workplace/chenzh/jpegenc_test/package/codecs/jpegenc/) [1, 0, 0]
@0,891,328us: [+4 T:0x40020100] OG - package ti.sdo.ce.global (/opt/dvsdk_4_00_00_22/codec-engine_2_26_01_09/packages/ti/sdo/ce/global/) [1, 0, 0]
@0,891,328us: [+4 T:0x40020100] OG - package ti.xdais.dm (/opt/dvsdk_4_00_00_22/xdais_6_26_01_03/packages/ti/xdais/dm/) [1, 0, 5]
@0,891,358us: [+4 T:0x40020100] OG - package ti.sdo.utils.trace (/opt/dvsdk_4_00_00_22/framework-components_2_25_03_07/packages/ti/sdo/utils/trace/) [1, 0, 0]
@0,891,389us: [+4 T:0x40020100] OG - package ti.sdo.ce.utils.xdm (/opt/dvsdk_4_00_00_22/codec-engine_2_26_01_09/packages/ti/sdo/ce/utils/xdm/) [1, 0, 2]
@0,891,419us: [+4 T:0x40020100] OG - package dsplink.gpp (/opt/dvsdk_4_00_00_22/dsplink_1_65_00_02/dsplink/gpp/) [5, 0, 0]
@0,891,419us: [+4 T:0x40020100] OG - package ti.sdo.linuxutils.cmem (/opt/dvsdk_4_00_00_22/linuxutils_2_25_05_11/packages/ti/sdo/linuxutils/cmem/) [2, 2, 0]
@0,891,450us: [+4 T:0x40020100] OG - package ti.bios.power (/opt/dvsdk_4_00_00_22/local-power-manager_1_24_02_09/packages/ti/bios/power/) [1, 1, 1]
@0,891,480us: [+4 T:0x40020100] OG - package ti.xdais (/opt/dvsdk_4_00_00_22/xdais_6_26_01_03/packages/ti/xdais/) [1, 2.0, 1]
@0,891,480us: [+4 T:0x40020100] OG - package ti.sdo.ce.node (/opt/dvsdk_4_00_00_22/codec-engine_2_26_01_09/packages/ti/sdo/ce/node/) [1, 0, 0]
@0,891,511us: [+4 T:0x40020100] OG - package ti.sdo.fc.global (/opt/dvsdk_4_00_00_22/framework-components_2_25_03_07/packages/ti/sdo/fc/global/) [1, 0, 0]
@0,891,511us: [+4 T:0x40020100] OG - package ti.sdo.fc.memutils (/opt/dvsdk_4_00_00_22/framework-components_2_25_03_07/packages/ti/sdo/fc/memutils/) [1, 0, 0]
@0,891,541us: [+4 T:0x40020100] OG - package ti.sdo.fc.utils (/opt/dvsdk_4_00_00_22/framework-components_2_25_03_07/packages/ti/sdo/fc/utils/) [1, 0, 2]
@0,891,572us: [+4 T:0x40020100] OG - package ti.sdo.fc.dman3 (/opt/dvsdk_4_00_00_22/framework-components_2_25_03_07/packages/ti/sdo/fc/dman3/) [1, 0, 4]
@0,891,572us: [+4 T:0x40020100] OG - package ti.sdo.fc.acpy3 (/opt/dvsdk_4_00_00_22/framework-components_2_25_03_07/packages/ti/sdo/fc/acpy3/) [1, 0, 4]
@0,891,602us: [+4 T:0x40020100] OG - package gnu.targets (/opt/dvsdk_4_00_00_22/xdctools_3_16_03_36/packages/gnu/targets/) [1, 0, 1]
@0,891,602us: [+4 T:0x40020100] OG - package gnu.targets.arm (/opt/dvsdk_4_00_00_22/xdctools_3_16_03_36/packages/gnu/targets/arm/) [1, 0, 0, 0]
@0,891,633us: [+4 T:0x40020100] OG - package ti.catalog.arm (/opt/dvsdk_4_00_00_22/xdctools_3_16_03_36/packages/ti/catalog/arm/) [1, 0, 1, 0]
@0,891,663us: [+4 T:0x40020100] OG - package ti.catalog (/opt/dvsdk_4_00_00_22/xdctools_3_16_03_36/packages/ti/catalog/) [1, 0, 0]
@0,891,663us: [+4 T:0x40020100] OG - package ti.catalog.c6000 (/opt/dvsdk_4_00_00_22/xdctools_3_16_03_36/packages/ti/catalog/c6000/) [1, 0, 0, 0]
@0,891,694us: [+4 T:0x40020100] OG - package ti.platforms.evm3530 (/opt/dvsdk_4_00_00_22/xdctools_3_16_03_36/packages/ti/platforms/evm3530/) [1, 0, 0]
@0,891,724us: [+4 T:0x40020100] OG - package ti.sdo.ce.osal (/opt/dvsdk_4_00_00_22/codec-engine_2_26_01_09/packages/ti/sdo/ce/osal/) [2, 0, 2]
@0,891,724us: [+4 T:0x40020100] OG - package ti.sdo.ce.ipc (/opt/dvsdk_4_00_00_22/codec-engine_2_26_01_09/packages/ti/sdo/ce/ipc/) [2, 0, 1]
@0,891,755us: [+4 T:0x40020100] OG - package ti.sdo.ce.osal.linux (/opt/dvsdk_4_00_00_22/codec-engine_2_26_01_09/packages/ti/sdo/ce/osal/linux/) [2, 0, 1]
@0,891,755us: [+4 T:0x40020100] OG - package ti.sdo.ce.ipc.dsplink (/opt/dvsdk_4_00_00_22/codec-engine_2_26_01_09/packages/ti/sdo/ce/ipc/dsplink/) [2, 0, 1]
@1,226,167us: [+4 T:0x40020100] OG - package ti.sdo.ce.alg (/opt/dvsdk_4_00_00_22/codec-engine_2_26_01_09/packages/ti/sdo/ce/alg/) [1, 0, 1]
@1,226,197us: [+4 T:0x40020100] OG - package ti.sdo.ce (/opt/dvsdk_4_00_00_22/codec-engine_2_26_01_09/packages/ti/sdo/ce/) [1, 0, 6]
@1,226,228us: [+4 T:0x40020100] OG - package ti.sdo.ce.image1 (/opt/dvsdk_4_00_00_22/codec-engine_2_26_01_09/packages/ti/sdo/ce/image1/) [1, 0, 1]
@1,226,228us: [+4 T:0x40020100] OG - package codecs.jpegenc.ce (/home/eric/workplace/chenzh/jpegenc_test/package/codecs/jpegenc/ce/) [1, 0, 0]
@1,226,258us: [+4 T:0x40020100] OG - package ti.sdo.ce.speech (/opt/dvsdk_4_00_00_22/codec-engine_2_26_01_09/packages/ti/sdo/ce/speech/) [1, 0, 2]
@1,226,289us: [+4 T:0x40020100] OG - package ti.sdo.ce.speech1 (/opt/dvsdk_4_00_00_22/codec-engine_2_26_01_09/packages/ti/sdo/ce/speech1/) [1, 0, 1]
@1,226,289us: [+4 T:0x40020100] OG - package ti.sdo.ce.audio (/opt/dvsdk_4_00_00_22/codec-engine_2_26_01_09/packages/ti/sdo/ce/audio/) [1, 0, 2]
@1,226,319us: [+4 T:0x40020100] OG - package ti.sdo.ce.audio1 (/opt/dvsdk_4_00_00_22/codec-engine_2_26_01_09/packages/ti/sdo/ce/audio1/) [1, 0, 1]
@1,226,319us: [+4 T:0x40020100] OG - package ti.sdo.ce.video (/opt/dvsdk_4_00_00_22/codec-engine_2_26_01_09/packages/ti/sdo/ce/video/) [1, 0, 3]
@1,226,350us: [+4 T:0x40020100] OG - package ti.sdo.ce.video1 (/opt/dvsdk_4_00_00_22/codec-engine_2_26_01_09/packages/ti/sdo/ce/video1/) [1, 0, 2]
@1,226,380us: [+4 T:0x40020100] OG - package ti.sdo.ce.video2 (/opt/dvsdk_4_00_00_22/codec-engine_2_26_01_09/packages/ti/sdo/ce/video2/) [1, 0, 2]
@1,226,380us: [+4 T:0x40020100] OG - package ti.sdo.ce.image (/opt/dvsdk_4_00_00_22/codec-engine_2_26_01_09/packages/ti/sdo/ce/image/) [1, 0, 3]
@1,226,411us: [+4 T:0x40020100] OG - package ti.sdo.dmai (/opt/dvsdk_4_00_00_22/dmai_2_20_00_10/packages/ti/sdo/dmai/) [1, 0, 0]
@1,226,411us: [+4 T:0x40020100] OG - package ti.sdo.ce.bioslog (/opt/dvsdk_4_00_00_22/codec-engine_2_26_01_09/packages/ti/sdo/ce/bioslog/) [1, 0, 1]
@1,226,441us: [+4 T:0x40020100] OG - package ti.sdo.ce.utils.trace (/opt/dvsdk_4_00_00_22/codec-engine_2_26_01_09/packages/ti/sdo/ce/utils/trace/) [1, 0, 1]
@1,226,472us: [+4 T:0x40020100] OG - package encode_config (/home/eric/workplace/chenzh/jpegenc_test/test_x64P/omap3530/encode/encode_config/) []
@1,226,716us: [+0 T:0x40020100] ti.sdo.ce.osal.Sem - Sem_create> count: 0
@1,226,746us: [+0 T:0x40020100] ti.sdo.ce.osal.Sem - Leaving Sem_create> sem[0x491c0]
@1,226,777us: [+0 T:0x40020100] ti.sdo.ce.osal.Sem - Sem_create> count: 0
@1,226,777us: [+0 T:0x40020100] ti.sdo.ce.osal.Sem - Leaving Sem_create> sem[0x491d8]
@1,226,807us: [+0 T:0x40020100] OT - Thread_create> Enter (fxn=0x18330, attrs=0x0)
@1,227,052us: [+0 T:0x40020100] OT - Thread_create> Exit (task=0x49210)
@1,227,143us: [+0 T:0x40020100] ti.sdo.ce.alg - ALG_init> Enter
@1,227,143us: [+0 T:0x40020100] ti.sdo.ce.alg - ALG_init> Exit
@1,227,204us: [+6 T:0x40020100] CE - Engine_init> CE debugging on (CE_DEBUG=2; allowed CE_DEBUG levels: 1=min, 2=good, 3=max)
@1,227,235us: [+0 T:0x40020100] CS - Server_init()
@1,227,265us: [+0 T:0x40020100] CS - Server_init> Global_useLinkArbiter = 0
TraceUtil_start> note: CE_DEBUG env. var is set, so TraceUtil is not active (unset CE_DEBUG if you need TraceUtil)
@1,227,326us: [+0 T:0x40020100] CE - Engine_open> Enter('hv_dsplib', 0x0, 0xbe88db6c)
@1,227,357us: [+0 T:0x40020100] CE - rserverOpen('hv_dsplib.x64P'), count = 0
@1,227,387us: [+0 T:0x40020100] OP - Processor_create> Enter(imageName='hv_dsplib.x64P', linkCfg='(null)', attrs=0xbe88db50)
@1,227,479us: [+0 T:0x40020100] OP - doCmd> Enter (cmdId=1, proc=0x49550)
@1,561,677us: [+0 T:0x40020100] ti.sdo.ce.osal.Sem - Entered Sem_post> sem[0x491c0]
@1,561,738us: [+0 T:0x40020100] ti.sdo.ce.osal.Sem - Leaving Sem_post> sem[0x491c0]
@1,561,768us: [+0 T:0x40020100] ti.sdo.ce.osal.Sem - Entered Sem_pend> sem[0x491d8] timeout[0xffffffff]
@1,561,799us: [+1 T:0x40cd2490] OP - daemon> thread created.
@1,561,829us: [+0 T:0x40cd2490] OP - getCmd_d> Enter (proc=0x40cd1dd8)
@1,561,860us: [+0 T:0x40cd2490] ti.sdo.ce.osal.Sem - Entered Sem_pend> sem[0x491c0] timeout[0xffffffff]
@1,561,860us: [+0 T:0x40cd2490] ti.sdo.ce.osal.Sem - Leaving Sem_pend> sem[0x491c0] status[0]
@1,561,890us: [+0 T:0x40cd2490] OP - getCmd_d> Exit (result=1)
@1,561,890us: [+0 T:0x40cd2490] OP - Processor_create_d> Enter(proc=0x49550)
@1,561,921us: [+0 T:0x40cd2490] ti.sdo.ce.ipc.Power - Power_on> Enter(handle=0x4956c)
@1,561,951us: [+2 T:0x40cd2490] ti.sdo.ce.ipc.Power - Power_on> Opening Local Power Manager for the DSP on /dev/lpm0...
@1,561,982us: [+2 T:0x40cd2490] ti.sdo.ce.ipc.Power - Power_on> Turning on DSP power...
@1,562,135us: [+2 T:0x40cd2490] ti.sdo.ce.ipc.Power - Power_on> return (0)
@1,562,135us: [+2 T:0x40cd2490] OP - Processor_create_d> Initializing DSP PROC...
@1,562,165us: [+2 T:0x40cd2490] OP - Processor_create_d> Using DspLink config data for entry #0 [server 'hv_dsplib.x64P']
@1,562,196us: [+2 T:0x40cd2490] OP - Processor_create_d> Adding DSP segment #0 to Link configuration: name='DDR2', startAddress=0x9fc00000, sizeInBytes=0x300000, shared=1, syncd=0
@1,562,226us: [+2 T:0x40cd2490] OP - Processor_create_d> Adding DSP segment #1 to Link configuration: name='DSPLINKMEM', startAddress=0x9ff00000, sizeInBytes=0xff000, shared=1, syncd=0
@1,562,257us: [+2 T:0x40cd2490] OP - Processor_create_d> Adding DSP segment #2 to Link configuration: name='RESET_VECTOR', startAddress=0x9ffff000, sizeInBytes=0x1000, shared=1, syncd=0
@1,562,287us: [+2 T:0x40cd2490] OP - Processor_create_d> Adding DSP segment #3 to Link configuration: name='L4PER', startAddress=0x49000000, sizeInBytes=0x100000, shared=0, syncd=0
@1,562,318us: [+2 T:0x40cd2490] OP - Processor_create_d> Adding DSP segment #4 to Link configuration: name='IRAM', startAddress=0x5c7f8000, sizeInBytes=0x8000, shared=1, syncd=0
@1,562,348us: [+2 T:0x40cd2490] OP - Processor_create_d> Adding DSP segment #5 to Link configuration: name='L1DSRAM', startAddress=0x5cf04000, sizeInBytes=0x10000, shared=1, syncd=0
@1,562,379us: [+2 T:0x40cd2490] OP - Processor_create_d> Adding DSP segment #6 to Link configuration: name='DDRALGHEAP', startAddress=0x94000000, sizeInBytes=0xbc00000, shared=0, syncd=0
@1,562,379us: [+2 T:0x40cd2490] OP - Processor_create_d> Adding DSP segment #7 to Link configuration: name='L4CORE', startAddress=0x48000000, sizeInBytes=0x1000000, shared=0, syncd=0
@1,562,409us: [+2 T:0x40cd2490] OP - Processor_create_d> Found 'CMEM' entry, adjusting base and size according to CMEM_getBlock()
@1,562,440us: [+0 T:0x40cd2490] OP - Processor_create_d> Setting CMEM base to 0x90000000, size to 0x4000000
@1,562,470us: [+2 T:0x40cd2490] OP - Processor_create_d> Adding DSP segment #8 to Link configuration: name='CMEM', startAddress=0x90000000, sizeInBytes=0x4000000, shared=0, syncd=0
@1,562,470us: [+2 T:0x40cd2490] OP - Processor_create_d> DODSPCTRL was=0; now=0
@1,562,501us: [+3 T:0x40cd2490] OP - LINKCFG_Object generated for PROC_setup(0x47e4c) ...
@1,562,531us: [+3 T:0x40cd2490] OP - linkCfg->gppObject->
@1,562,562us: [+3 T:0x40cd2490] OP - name = "ARM9"
@1,562,592us: [+3 T:0x40cd2490] OP - maxMsgqs = 0x82
@1,562,592us: [+3 T:0x40cd2490] OP - maxChnlQueue = 0x10
@1,562,623us: [+3 T:0x40cd2490] OP - poolTableId = 0xffffffff
@1,562,623us: [+3 T:0x40cd2490] OP - numPools = 0x0
@1,562,653us: [+3 T:0x40cd2490] OP -
@1,562,653us: [+3 T:0x40cd2490] OP - linkCfg->dspConfigs[0]->dspObject->
@1,897,187us: [+3 T:0x40cd2490] OP - name = "OMAP3530"
@1,897,218us: [+3 T:0x40cd2490] OP - dspArch = 0x2
@1,897,248us: [+3 T:0x40cd2490] OP - loaderName = "COFF"
@1,897,248us: [+3 T:0x40cd2490] OP - autoStart = FALSE
@1,897,279us: [+3 T:0x40cd2490] OP - execName = "DEFAULT.OUT"
@1,897,279us: [+3 T:0x40cd2490] OP - doDspCtrl = DSP_BootMode_Boot_NoPwr
@1,897,309us: [+3 T:0x40cd2490] OP - resumeAddr = 0x9ffff020
@1,897,309us: [+3 T:0x40cd2490] OP - resetVector = 0x9ffff000
@1,897,340us: [+3 T:0x40cd2490] OP - resetCodeSize = 0x1000
@1,897,370us: [+3 T:0x40cd2490] OP - maduSize = 0x1
@1,897,370us: [+3 T:0x40cd2490] OP - cpuFreq = 0x6ddd0
@1,897,401us: [+3 T:0x40cd2490] OP - endian = 0x3
@1,897,401us: [+3 T:0x40cd2490] OP - wordSwap = 0x0
@1,897,431us: [+3 T:0x40cd2490] OP - memTableId = 0x0
@1,897,431us: [+3 T:0x40cd2490] OP - memEntries = 0x9
@1,897,462us: [+3 T:0x40cd2490] OP - linkDrvId = 0x0
@1,897,462us: [+3 T:0x40cd2490] OP - arg1 = 0xffffffff
@1,897,492us: [+3 T:0x40cd2490] OP - arg2 = 0xffffffff
@1,897,492us: [+3 T:0x40cd2490] OP - arg3 = 0x0
@1,897,523us: [+3 T:0x40cd2490] OP - arg4 = 0x0
@1,897,523us: [+3 T:0x40cd2490] OP - arg5 = 0xffffffff
@1,897,553us: [+3 T:0x40cd2490] OP -
@1,897,553us: [+3 T:0x40cd2490] OP - linkCfg->dspConfigs[0]->linkDrvObjects->
@1,897,584us: [+3 T:0x40cd2490] OP - name = "SHMDRV"
@1,897,614us: [+3 T:0x40cd2490] OP - hshkPollCount = 0x989680
@1,897,614us: [+3 T:0x40cd2490] OP - memEntry = 0x1
@1,897,645us: [+3 T:0x40cd2490] OP - ipsTableId = 0x0
@1,897,645us: [+3 T:0x40cd2490] OP - numIpsEntries = 0x1
@1,897,675us: [+3 T:0x40cd2490] OP - poolTableId = 0x0
@1,897,675us: [+3 T:0x40cd2490] OP - numPools = 0x1
@1,897,706us: [+3 T:0x40cd2490] OP - dataTableId = 0x0
@1,897,706us: [+3 T:0x40cd2490] OP - numDataDrivers = 0x1
@1,897,736us: [+3 T:0x40cd2490] OP - mqtId = 0x0
@1,897,736us: [+3 T:0x40cd2490] OP - ringIoTableId = 0x0
@1,897,767us: [+3 T:0x40cd2490] OP - mplistTableId = 0x0
@1,897,767us: [+3 T:0x40cd2490] OP - mpcsTableId = 0x0
@1,897,797us: [+3 T:0x40cd2490] OP -
@1,897,797us: [+3 T:0x40cd2490] OP - linkCfg->dspConfigs[0]->memTables[0][i].
@1,897,828us: [+3 T:0x40cd2490] OP - entry #0:
@1,897,858us: [+3 T:0x40cd2490] OP - entry = 0x0
@1,897,858us: [+3 T:0x40cd2490] OP - name = "DDR2"
@1,897,889us: [+3 T:0x40cd2490] OP - physAddr = 0x9fc00000
@1,897,889us: [+3 T:0x40cd2490] OP - dspVirtAddr = 0x9fc00000
@1,897,919us: [+3 T:0x40cd2490] OP - gppVirtAddr = 0xffffffff
@1,897,919us: [+3 T:0x40cd2490] OP - size = 0x300000
@1,897,950us: [+3 T:0x40cd2490] OP - shared = TRUE
@1,897,950us: [+3 T:0x40cd2490] OP - syncd = FALSE
@1,897,980us: [+3 T:0x40cd2490] OP - entry #1:
@1,897,980us: [+3 T:0x40cd2490] OP - entry = 0x1
@1,898,011us: [+3 T:0x40cd2490] OP - name = "DSPLINKMEM"
@1,898,042us: [+3 T:0x40cd2490] OP - physAddr = 0x9ff00000
@1,898,042us: [+3 T:0x40cd2490] OP - dspVirtAddr = 0x9ff00000
@1,898,072us: [+3 T:0x40cd2490] OP - gppVirtAddr = 0xffffffff
@1,898,072us: [+3 T:0x40cd2490] OP - size = 0xff000
@1,898,103us: [+3 T:0x40cd2490] OP - shared = TRUE
@1,898,103us: [+3 T:0x40cd2490] OP - syncd = FALSE
@1,898,133us: [+3 T:0x40cd2490] OP - entry #2:
@1,898,133us: [+3 T:0x40cd2490] OP - entry = 0x2
@1,898,164us: [+3 T:0x40cd2490] OP - name = "RESET_VECTOR"
@1,898,164us: [+3 T:0x40cd2490] OP - physAddr = 0x9ffff000
@1,898,194us: [+3 T:0x40cd2490] OP - dspVirtAddr = 0x9ffff000
@1,898,225us: [+3 T:0x40cd2490] OP - gppVirtAddr = 0xffffffff
@1,898,225us: [+3 T:0x40cd2490] OP - size = 0x1000
@1,898,255us: [+3 T:0x40cd2490] OP - shared = TRUE
@1,898,255us: [+3 T:0x40cd2490] OP - syncd = FALSE
@1,898,286us: [+3 T:0x40cd2490] OP - entry #3:
@2,232,880us: [+3 T:0x40cd2490] OP - entry = 0x3
@2,232,880us: [+3 T:0x40cd2490] OP - name = "L4PER"
@2,232,911us: [+3 T:0x40cd2490] OP - physAddr = 0x49000000
@2,232,911us: [+3 T:0x40cd2490] OP - dspVirtAddr = 0x49000000
@2,232,941us: [+3 T:0x40cd2490] OP - gppVirtAddr = 0xffffffff
@2,232,972us: [+3 T:0x40cd2490] OP - size = 0x100000
@2,232,972us: [+3 T:0x40cd2490] OP - shared = FALSE
@2,233,002us: [+3 T:0x40cd2490] OP - syncd = FALSE
@2,233,002us: [+3 T:0x40cd2490] OP - entry #4:
@2,233,033us: [+3 T:0x40cd2490] OP - entry = 0x4
@2,233,033us: [+3 T:0x40cd2490] OP - name = "IRAM"
@2,233,063us: [+3 T:0x40cd2490] OP - physAddr = 0x5c7f8000
@2,233,063us: [+3 T:0x40cd2490] OP - dspVirtAddr = 0x107f8000
@2,233,094us: [+3 T:0x40cd2490] OP - gppVirtAddr = 0xffffffff
@2,233,125us: [+3 T:0x40cd2490] OP - size = 0x8000
@2,233,125us: [+3 T:0x40cd2490] OP - shared = TRUE
@2,233,155us: [+3 T:0x40cd2490] OP - syncd = FALSE
@2,233,155us: [+3 T:0x40cd2490] OP - entry #5:
@2,233,186us: [+3 T:0x40cd2490] OP - entry = 0x5
@2,233,186us: [+3 T:0x40cd2490] OP - name = "L1DSRAM"
@2,233,216us: [+3 T:0x40cd2490] OP - physAddr = 0x5cf04000
@2,233,216us: [+3 T:0x40cd2490] OP - dspVirtAddr = 0x10f04000
@2,233,247us: [+3 T:0x40cd2490] OP - gppVirtAddr = 0xffffffff
@2,233,247us: [+3 T:0x40cd2490] OP - size = 0x10000
@2,233,277us: [+3 T:0x40cd2490] OP - shared = TRUE
@2,233,277us: [+3 T:0x40cd2490] OP - syncd = FALSE
@2,233,308us: [+3 T:0x40cd2490] OP - entry #6:
@2,233,338us: [+3 T:0x40cd2490] OP - entry = 0x6
@2,233,338us: [+3 T:0x40cd2490] OP - name = "DDRALGHEAP"
@2,233,369us: [+3 T:0x40cd2490] OP - physAddr = 0x94000000
@2,233,369us: [+3 T:0x40cd2490] OP - dspVirtAddr = 0x94000000
@2,233,399us: [+3 T:0x40cd2490] OP - gppVirtAddr = 0xffffffff
@2,233,399us: [+3 T:0x40cd2490] OP - size = 0xbc00000
@2,233,430us: [+3 T:0x40cd2490] OP - shared = FALSE
@2,233,430us: [+3 T:0x40cd2490] OP - syncd = FALSE
@2,233,460us: [+3 T:0x40cd2490] OP - entry #7:
@2,233,460us: [+3 T:0x40cd2490] OP - entry = 0x7
@2,233,491us: [+3 T:0x40cd2490] OP - name = "L4CORE"
@2,233,491us: [+3 T:0x40cd2490] OP - physAddr = 0x48000000
@2,233,521us: [+3 T:0x40cd2490] OP - dspVirtAddr = 0x48000000
@2,233,552us: [+3 T:0x40cd2490] OP - gppVirtAddr = 0xffffffff
@2,233,552us: [+3 T:0x40cd2490] OP - size = 0x1000000
@2,233,582us: [+3 T:0x40cd2490] OP - shared = FALSE
@2,233,582us: [+3 T:0x40cd2490] OP - syncd = FALSE
@2,233,613us: [+3 T:0x40cd2490] OP - entry #8:
@2,233,613us: [+3 T:0x40cd2490] OP - entry = 0x8
@2,233,643us: [+3 T:0x40cd2490] OP - name = "CMEM"
@2,233,643us: [+3 T:0x40cd2490] OP - physAddr = 0x90000000
@2,233,674us: [+3 T:0x40cd2490] OP - dspVirtAddr = 0x90000000
@2,233,674us: [+3 T:0x40cd2490] OP - gppVirtAddr = 0xffffffff
@2,233,704us: [+3 T:0x40cd2490] OP - size = 0x4000000
@2,233,704us: [+3 T:0x40cd2490] OP - shared = FALSE
@2,233,735us: [+3 T:0x40cd2490] OP - syncd = FALSE
@2,233,735us: [+3 T:0x40cd2490] OP -
@2,233,765us: [+3 T:0x40cd2490] OP - linkCfg->dspConfigs[0]->ipsTables[0][i].
@2,233,796us: [+3 T:0x40cd2490] OP - entry #0:
@2,233,796us: [+3 T:0x40cd2490] OP - name = "IPS"
@2,233,826us: [+3 T:0x40cd2490] OP - numIpsEvents = 0x20
@2,233,826us: [+3 T:0x40cd2490] OP - memEntry = 0x1
@2,233,857us: [+3 T:0x40cd2490] OP - gppIntId = 0x1a
@2,233,857us: [+3 T:0x40cd2490] OP - dspIntId = 0x37
@2,233,887us: [+3 T:0x40cd2490] OP - dspIntVectorId = 0x5
@2,233,887us: [+3 T:0x40cd2490] OP - arg1 = 0x2faf080
@2,233,918us: [+3 T:0x40cd2490] OP - arg2 = 0x0
@2,233,918us: [+3 T:0x40cd2490] OP -
@2,233,949us: [+3 T:0x40cd2490] OP - linkCfg->dspConfigs[0]->poolTables[0][i].
@2,233,949us: [+3 T:0x40cd2490] OP -
@2,233,979us: [+3 T:0x40cd2490] OP - linkCfg->dspConfigs[0]->dataTables[0][i].
@2,568,391us: [+3 T:0x40cd2490] OP - entry #0:
@2,568,391us: [+3 T:0x40cd2490] OP - name = "ZCPYDATA"
@2,568,421us: [+3 T:0x40cd2490] OP - baseChnlId = 0x0
@2,568,452us: [+3 T:0x40cd2490] OP - numChannels = 0x10
@2,568,452us: [+3 T:0x40cd2490] OP - maxBufSize = 0x4000
@2,568,482us: [+3 T:0x40cd2490] OP - memEntry = 0x1
@2,568,482us: [+3 T:0x40cd2490] OP - poolId = 0x0
@2,568,513us: [+3 T:0x40cd2490] OP - queuePerChnl = 0x1
@2,568,513us: [+3 T:0x40cd2490] OP - ipsId = 0x0
@2,568,543us: [+3 T:0x40cd2490] OP - ipsEventNo = 0x1
@2,568,543us: [+3 T:0x40cd2490] OP - arg1 = 0x0
@2,568,574us: [+3 T:0x40cd2490] OP - arg2 = 0x0
@2,568,574us: [+3 T:0x40cd2490] OP -
@2,568,604us: [+3 T:0x40cd2490] OP - linkCfg->dspConfigs[0]->mqtObjects->
@2,568,604us: [+3 T:0x40cd2490] OP - name = "ZCPYMQT"
@2,568,635us: [+3 T:0x40cd2490] OP - memEntry = 0x1
@2,568,635us: [+3 T:0x40cd2490] OP - maxMsgSize = 0xffffffff
@2,568,665us: [+3 T:0x40cd2490] OP - ipsId = 0x0
@2,568,696us: [+3 T:0x40cd2490] OP - ipsEventNo = 0x0
@2,568,696us: [+3 T:0x40cd2490] OP - arg1 = 0x0
@2,568,726us: [+3 T:0x40cd2490] OP - arg2 = 0x0
@2,568,726us: [+3 T:0x40cd2490] OP -
@2,568,757us: [+3 T:0x40cd2490] OP - linkCfg->dspConfigs[0]->ringIoObjects->
@2,568,757us: [+3 T:0x40cd2490] OP - name = "RINGIOTABLE"
@2,568,787us: [+3 T:0x40cd2490] OP - memEntry = 0x1
@2,568,787us: [+3 T:0x40cd2490] OP - maxEntries = 0x40
@2,568,818us: [+3 T:0x40cd2490] OP - ipsId = 0x0
@2,568,818us: [+3 T:0x40cd2490] OP - ipsEventNo = 0x2
@2,568,848us: [+3 T:0x40cd2490] OP -
@2,568,848us: [+3 T:0x40cd2490] OP - linkCfg->dspConfigs[0]->mplistObjects->
@2,568,879us: [+3 T:0x40cd2490] OP - name = "MPLISTTABLE"
@2,568,879us: [+3 T:0x40cd2490] OP - memEntry = 0x1
@2,568,909us: [+3 T:0x40cd2490] OP - maxEntries = 0x40
@2,568,940us: [+3 T:0x40cd2490] OP - ipsId = 0xffffffff
@2,568,940us: [+3 T:0x40cd2490] OP - ipsEventNo = 0xffffffff
@2,568,970us: [+3 T:0x40cd2490] OP -
@2,568,970us: [+3 T:0x40cd2490] OP - linkCfg->dspConfigs[0]->mpcsObjects->
@2,569,001us: [+3 T:0x40cd2490] OP - name = "MPCS"
@2,569,001us: [+3 T:0x40cd2490] OP - memEntry = 0x1
@2,569,032us: [+3 T:0x40cd2490] OP - maxEntries = 0x100
@2,569,032us: [+3 T:0x40cd2490] OP - ipsId = 0xffffffff
@2,569,062us: [+3 T:0x40cd2490] OP - ipsEventNo = 0xffffffff
@2,570,039us: [+2 T:0x40cd2490] OP - Processor_create_d> Attaching to DSP PROC...
@2,573,487us: [+2 T:0x40cd2490] OP - Processor_create_d> Opening MSGQ pool...
@2,573,762us: [+2 T:0x40cd2490] OP - Processor_create_d> Loading hv_dsplib.x64P on DSP (1 args)...
@2,581,635us: [+2 T:0x40cd2490] OP - Processor_create_d> Starting DSP PROC...
@2,587,769us: [+2 T:0x40cd2490] OP - Processor_create_d> Opening remote transport...
@2,588,319us: [+0 T:0x40cd2490] ti.sdo.ce.ipc.Power - Power_connect> Enter (handle=0x49578)
@2,588,380us: [+2 T:0x40cd2490] ti.sdo.ce.ipc.Power - Power_connect> Calling LPM_connect to connect to the DSP power handler...
@2,588,471us: [+0 T:0x40cd2490] ti.sdo.ce.ipc.Power - Power_connect> return (0)
@2,588,502us: [+2 T:0x40cd2490] OP - Processor_create_d> return (1)
@2,588,532us: [+0 T:0x40cd2490] ti.sdo.ce.osal.Sem - Entered Sem_post> sem[0x491d8]
@2,588,593us: [+0 T:0x40020100] ti.sdo.ce.osal.Sem - Leaving Sem_pend> sem[0x491d8] status[0]
@2,588,624us: [+0 T:0x40020100] OP - doCmd> Exit (result=1)
@2,588,624us: [+0 T:0x40020100] OP - Processor_create> return (0x49550)
@2,588,715us: [+0 T:0x40020100] CE - rserverOpen('hv_dsplib.x64P'): 0x486b0 done.
@2,589,173us: [+0 T:0x40cd2490] ti.sdo.ce.osal.Sem - Leaving Sem_post> sem[0x491d8]
@2,589,265us: [+0 T:0x40cd2490] OP - getCmd_d> Enter (proc=0x40cd1dd8)
@2,589,265us: [+0 T:0x40cd2490] ti.sdo.ce.osal.Sem - Entered Sem_pend> sem[0x491c0] timeout[0xffffffff]
@2,589,356us: [+0 T:0x40020100] CE - checkServer(0x49518)
@2,589,539us: [+0 T:0x40020100] CE - rmsInit> RMS initialized(0x49518); CE_DEBUG on, setting DSP trace mask to *+01234567,CR=67,ti.sdo.fc.dman3-2,ti.sdo.fc.dskt2-2,GT_prefix=1235,GT_time=3
@2,923,524us: [+0 T:0x40020100] CE - Engine_setTrace> Enter(engine=0x49518, mask='*+01234567,CR=67,ti.sdo.fc.dman3-2,ti.sdo.fc.dskt2-2,GT_prefix=1235,GT_time=3')
@2,923,615us: [+1 T:0x40020100] CE - Engine_setTrace> Requesting DSP set trace ...
@2,924,592us: [+0 T:0x40020100] CE - Engine_setTrace> return(0)
@2,924,622us: [+4 T:0x40020100] CE - Engine_open> engine->server = 0x486b0
[DSP] @0x000002be:[T:0x00000000] servers.imgalg - main> Welcome to DSP server's main().
[DSP] @1,049,951tk: [+0 T:0x9fc302d4] OG - Global_setSpecialTrace> enter(mask='*+01234567,CR=67,ti.sdo.fc.dman3-2,ti.sdo.fc.dskt2-2,GT_prefix=1235,GT_time=3')
[DSP] @1,050,039tk: [+4 T:0x9fc302d4] OG - Global_setSpecialTrace> This program was built with the following packages:
[DSP] @1,050,092tk: [+4 T:0x9fc302d4] OG - package ti.targets.rts6000 (/opt/dvsdk_4_00_00_22/xdctools_3_16_03_36/packages/ti/targets/rts6000/) [1, 0, 0, 0]
[DSP] @1,050,158tk: [+4 T:0x9fc302d4] OG - package ti.sdo.codecs.jpegenc (/opt/dvsdk_4_00_00_22/codecs-omap3530_4_00_00_00/packages/ti/sdo/codecs/jpegenc/) [1, 0, 0]
[DSP] @1,050,230tk: [+4 T:0x9fc302d4] OG - package codecs.jpegenc (/home/eric/workplace/chenzh/jpegenc_test/package/codecs/jpegenc/) [1, 0, 0]
[DSP] @1,050,292tk: [+4 T:0x9fc302d4] OG - package ti.sdo.fc.global (/opt/dvsdk_4_00_00_22/framework-components_2_25_03_07/packages/ti/sdo/fc/global/) [1, 0, 0]
[DSP] @1,050,361tk: [+4 T:0x9fc302d4] OG - package ti.sdo.utils.trace (/opt/dvsdk_4_00_00_22/framework-components_2_25_03_07/packages/ti/sdo/utils/trace/) [1, 0, 0]
[DSP] @1,050,431tk: [+4 T:0x9fc302d4] OG - package ti.xdais (/opt/dvsdk_4_00_00_22/xdais_6_26_01_03/packages/ti/xdais/) [1, 2.0, 1]
[DSP] @1,050,489tk: [+4 T:0x9fc302d4] OG - package ti.rtdx (/opt/dvsdk_4_00_00_22/dspbios_5_41_03_17/packages/ti/rtdx/) [2, 0, 0, 5]
[DSP] @1,050,547tk: [+4 T:0x9fc302d4] OG - package ti.psl (/opt/dvsdk_4_00_00_22/dspbios_5_41_03_17/packages/ti/psl/) [5, 0, 0, 0]
[DSP] @1,050,604tk: [+4 T:0x9fc302d4] OG - package ti.pmi (/opt/dvsdk_4_00_00_22/dspbios_5_41_03_17/packages/ti/pmi/) [1, 0, 0, 0]
[DSP] @1,050,662tk: [+4 T:0x9fc302d4] OG - package ti.pscl (/opt/dvsdk_4_00_00_22/dspbios_5_41_03_17/packages/ti/pscl/) [1, 0, 0, 0]
[DSP] @1,050,721tk: [+4 T:0x9fc302d4] OG - package ti.bios (/opt/dvsdk_4_00_00_22/dspbios_5_41_03_17/packages/ti/bios/) [5, 2, 5, 28]
[DSP] @1,050,779tk: [+4 T:0x9fc302d4] OG - package ti.sdo.fc.dskt2 (/opt/dvsdk_4_00_00_22/framework-components_2_25_03_07/packages/ti/sdo/fc/dskt2/) [1, 0, 4]
[DSP] @1,050,847tk: [+4 T:0x9fc302d4] OG - package ti.sdo.fc.dman3 (/opt/dvsdk_4_00_00_22/framework-components_2_25_03_07/packages/ti/sdo/fc/dman3/) [1, 0, 4]
[DSP] @1,050,915tk: [+4 T:0x9fc302d4] OG - package ti.sdo.ce.global (/opt/dvsdk_4_00_00_22/codec-engine_2_26_01_09/packages/ti/sdo/ce/global/) [1, 0, 0]
[DSP] @1,050,980tk: [+4 T:0x9fc302d4] OG - package ti.xdais.dm (/opt/dvsdk_4_00_00_22/xdais_6_26_01_03/packages/ti/xdais/dm/) [1, 0, 5]
[DSP] @1,051,040tk: [+4 T:0x9fc302d4] OG - package ti.sdo.ce.node (/opt/dvsdk_4_00_00_22/codec-engine_2_26_01_09/packages/ti/sdo/ce/node/) [1, 0, 0]
[DSP] @1,051,104tk: [+4 T:0x9fc302d4] OG - package ti.sdo.ce.ipc.dsplink.dsp (/opt/dvsdk_4_00_00_22/codec-engine_2_26_01_09/packages/ti/sdo/ce/ipc/dsplink/dsp/) [2, 0, 1]
[DSP] @1,051,176tk: [+4 T:0x9fc302d4] OG - package ti.sdo.ce.utils.xdm (/opt/dvsdk_4_00_00_22/codec-engine_2_26_01_09/packages/ti/sdo/ce/utils/xdm/) [1, 0, 2]
[DSP] @1,051,244tk: [+4 T:0x9fc302d4] OG - package ti.sdo.fc.memutils (/opt/dvsdk_4_00_00_22/framework-components_2_25_03_07/packages/ti/sdo/fc/memutils/) [1, 0, 0]
[DSP] @1,051,314tk: [+4 T:0x9fc302d4] OG - package ti.sdo.fc.acpy3 (/opt/dvsdk_4_00_00_22/framework-components_2_25_03_07/packages/ti/sdo/fc/acpy3/) [1, 0, 4]
[DSP] @1,051,382tk: [+4 T:0x9fc302d4] OG - package dsplink.dsp (/opt/dvsdk_4_00_00_22/dsplink_1_65_00_02/dsplink/dsp/) [1, 4, 0]
[DSP] @1,051,439tk: [+4 T:0x9fc302d4] OG - package ti.bios.utils (/opt/dvsdk_4_00_00_22/biosutils_1_02_02/packages/ti/bios/utils/) [2, 0, 2, 02]
[DSP] @1,051,501tk: [+4 T:0x9fc302d4] OG - package ti.catalog.c6000 (/opt/dvsdk_4_00_00_22/xdctools_3_16_03_36/packages/ti/catalog/c6000/) [1, 0, 0, 0]
[DSP] @1,051,567tk: [+4 T:0x9fc302d4] OG - package ti.catalog (/opt/dvsdk_4_00_00_22/xdctools_3_16_03_36/packages/ti/catalog/) [1, 0, 0]
[DSP] @1,051,626tk: [+4 T:0x9fc302d4] OG - package ti.catalog.arm (/opt/dvsdk_4_00_00_22/xdctools_3_16_03_36/packages/ti/catalog/arm/) [1, 0, 1, 0]
[DSP] @1,051,690tk: [+4 T:0x9fc302d4] OG - package ti.platforms.evm3530 (/opt/dvsdk_4_00_00_22/xdctools_3_16_03_36/packages/ti/platforms/evm3530/) [1, 0, 0]
[DSP] @1,051,757tk: [+4 T:0x9fc302d4] OG - package ti.sdo.ce.osal (/opt/dvsdk_4_00_00_22/codec-engine_2_26_01_09/packages/ti/sdo/ce/osal/) [2, 0, 2]
[DSP] @1,051,821tk: [+4 T:0x9fc302d4] OG - package ti.sdo.ce.osal.bios (/opt/dvsdk_4_00_00_22/codec-engine_2_26_01_09/packages/ti/sdo/ce/osal/bios/) [2, 0, 1]
[DSP] @1,051,889tk: [+4 T:0x9fc302d4] OG - package ti.sdo.ce.ipc (/opt/dvsdk_4_00_00_22/codec-engine_2_26_01_09/packages/ti/sdo/ce/ipc/) [2, 0, 1]
[DSP] @1,051,953tk: [+4 T:0x9fc302d4] OG - package ti.sdo.ce.ipc.bios (/opt/dvsdk_4_00_00_22/codec-engine_2_26_01_09/packages/ti/sdo/ce/ipc/bios/) [2, 0, 1]
[DSP] @1,052,020tk: [+4 T:0x9fc302d4] OG - package ti.sdo.ce.alg (/opt/dvsdk_4_00_00_22/codec-engine_2_26_01_09/packages/ti/sdo/ce/alg/) [1, 0, 1]
[DSP] @1,052,084tk: [+4 T:0x9fc302d4] OG - package ti.sdo.ce (/opt/dvsdk_4_00_00_22/codec-engine_2_26_01_09/packages/ti/sdo/ce/) [1, 0, 6]
[DSP] @1,052,143tk: [+4 T:0x9fc302d4] OG - package ti.sdo.ce.bioslog (/opt/dvsdk_4_00_00_22/codec-engine_2_26_01_09/packages/ti/sdo/ce/bioslog/) [1, 0, 1]
[DSP] @1,052,210tk: [+4 T:0x9fc302d4] OG - package ti.sdo.ce.image1 (/opt/dvsdk_4_00_00_22/codec-engine_2_26_01_09/packages/ti/sdo/ce/image1/) [1, 0, 1]
[DSP] @1,052,275tk: [+4 T:0x9fc302d4] OG - package codecs.jpegenc.ce (/home/eric/workplace/chenzh/jpegenc_test/package/codecs/jpegenc/ce/) [1, 0, 0]
[DSP] @1,052,340tk: [+4 T:0x9fc302d4] OG - package servers.hv_dsplib (/home/eric/workplace/chenzh/jpegenc_test/package/servers/hv_dsplib/) [1, 0, 0]
[DSP] @1,052,404tk: [+0 T:0x9fc302d4] OG - Global_setSpecialTrace> return
@3,263,673us: [+0 T:0x40020100] CE - Engine_fwriteTrace> returning count [5951]
@3,263,703us: [+0 T:0x40020100] CE - Engine_initFromServer(0x49518)
@3,263,734us: [+0 T:0x40020100] CE - Engine_getNumServerAlgs(0x49518 0xbe88db08)
@3,263,978us: [+0 T:0x40020100] CE - Engine_getNumServerAlgs number of server algs = 1
@3,264,008us: [+0 T:0x40020100] CE - Engine_getNumServerAlgs exit 0
@3,264,039us: [+2 T:0x40020100] CE - Engine_initFromServer> Number of remote algs statically configured in engine: 1
@3,264,069us: [+2 T:0x40020100] CE - Engine_initFromServer> Number of statically configured remote algs = number of server algs: 1
@3,264,069us: [+0 T:0x40020100] CE - Engine_initFromServer> Returning 0
@3,264,100us: [+0 T:0x40020100] CE - Engine_open> return(300312)
Success to open engine hv_dsplib
@3,264,191us: [+0 T:0x40020100] ti.sdo.ce.image1.IMGENC1 - IMGENC1_create> Enter (engine=0x49518, name='jpegenc', params=0x0)
@3,264,222us: [+0 T:0x40020100] CV - VISA_create(0x49518, 'jpegenc', 0x0, 0x460, 'ti.sdo.ce.image1.IIMGENC1')
@3,264,252us: [+0 T:0x40020100] CV - VISA_create2(0x49518, 'jpegenc', 0x0, 0x0, 0x460, 'ti.sdo.ce.image1.IIMGENC1')
@3,264,283us: [+0 T:0x40020100] OM - Memory_alloc> Enter(0x34)
@3,264,313us: [+0 T:0x40020100] OM - Memory_alloc> return (0x49990)
@3,597,443us: [+0 T:0x40020100] OM - Memory_alloc> Enter(0x4)
@3,597,474us: [+0 T:0x40020100] OM - Memory_alloc> return (0x499c8)
@3,597,474us: [+0 T:0x40020100] OC - Comm_alloc> Enter(poolId=0x0, msg=0x499c8, size=460)
@3,597,504us: [+0 T:0x40020100] OC - Comm_alloc> msg=0x414e3880, returning (0)
@3,597,535us: [+0 T:0x40020100] CE - Engine_createNode(0x49518, 'jpegenc', 460, 0x0, 0x0, 0xbe88daf8)
@3,597,565us: [+0 T:0x40020100] CE - Engine> allocNode Enter(engine=0x49518, impId='jpegenc')
@3,597,596us: [+0 T:0x40020100] OM - Memory_alloc> Enter(0x20)
@3,597,596us: [+0 T:0x40020100] OM - Memory_alloc> return (0x499d8)
@3,597,626us: [+0 T:0x40020100] CE - Engine> allocNode(). Calling (Comm_create(gppfromnode_1723_1, 0x499e0, NULL)
@3,597,657us: [+0 T:0x40020100] OC - Comm_create> Enter(queueName='gppfromnode_1723_1', queue=0x499e0, attrs=0x0)
@3,597,657us: [+0 T:0x40020100] OM - Memory_alloc> Enter(0x4)
@3,597,688us: [+0 T:0x40020100] OM - Memory_alloc> return (0x49a00)
@3,597,962us: [+0 T:0x40020100] OC - Comm_create> return (0x49a00)
@3,597,993us: [+0 T:0x40020100] OC - Comm_put> Enter(queue=0x0, msg=0x414e2880)
@3,598,023us: [+0 T:0x40020100] OC - Comm_put> return (0)
@3,598,054us: [+0 T:0x40020100] OC - Comm_get> Enter(queue=0x10000, msg=0xbe88da0c, timeout=-1)
@3,598,756us: [+0 T:0x40020100] OC - Comm_get> MSGQ_get() status=0x8000, return (0)
@3,598,786us: [+0 T:0x40020100] OC - Comm_put> Enter(queue=0x0, msg=0x414e2880)
@3,598,817us: [+0 T:0x40020100] OC - Comm_put> return (0)
@3,598,847us: [+0 T:0x40020100] OC - Comm_get> Enter(queue=0x10000, msg=0xbe88da0c, timeout=-1)
@3,598,908us: [+0 T:0x40020100] OC - Comm_get> MSGQ_get() status=0x8000, return (0)
@3,598,908us: [+4 T:0x40020100] CE - Engine_createNode> created node(stdIn=0x2, stdOut=0x10001, msgq=0x49a00, algName='jpegenc', rmsNode=0x9fc34db0, algHandle=0x9fc34ea0)
@3,598,939us: [+3 T:0x40020100] CE - Engine_fwriteTrace(0x49518, '[DSP] ', 0x404b35e8)
@3,598,969us: [+3 T:0x40020100] CE - Engine_fwriteTrace(): requesting DSP trace @0x36ea79 ...
@3,599,000us: [+0 T:0x40020100] OC - Comm_put> Enter(queue=0x0, msg=0x414e2880)
@3,599,030us: [+0 T:0x40020100] OC - Comm_put> return (0)
@3,599,030us: [+0 T:0x40020100] OC - Comm_get> Enter(queue=0x10000, msg=0xbe88d984, timeout=-1)
@3,599,091us: [+0 T:0x40020100] OC - Comm_get> MSGQ_get() status=0x8000, return (0)
@3,599,122us: [+3 T:0x40020100] CE - Engine_fwriteTrace> got 2104 chars @0x36ea79 (0 still avail, max: 32744, lost: 0)
[DSP] @3,157,099tk: [+0 T:0x9fc302d4] OM - Memory_alloc> Enter(size=0x18)
[DSP] @3,157,148tk: [+0 T:0x9fc302d4] OM - Memory_alloc> return (0x9fc34db0)
[DSP] @3,157,189tk: [+0 T:0x9fc302d4] OM - Memory_alloc> Enter(size=0xa)
[DSP] @3,157,225tk: [+0 T:0x9fc302d4] OM - Memory_alloc> return (0x9fc34dc8)
[DSP] @3,157,283tk: [+0 T:0x9fc302d4] OM - Memory_alloc> Enter(size=0x20)
[DSP] @3,157,320tk: [+0 T:0x9fc302d4] OM - Memory_alloc> return (0x9fc34dd8)
[DSP] @3,157,364tk: [+0 T:0x9fc302d4] OM - Memory_alloc> Enter(size=0x24)
[DSP] @3,157,401tk: [+0 T:0x9fc302d4] OM - Memory_alloc> return (0x9fc34df8)
[DSP] @3,157,470tk: [+0 T:0x9fc302d4] ti.sdo.ce.image1.IMGENC1 - IMGENC1_create> Enter (engine=0x0, name='jpegenc', params=0x0)
[DSP] @3,157,539tk: [+0 T:0x9fc302d4] CV - VISA_create(0x0, 'jpegenc', 0x0, 0x460, 'ti.sdo.ce.image1.IIMGENC1')
[DSP] @3,157,599tk: [+0 T:0x9fc302d4] CV - VISA_create2(0x0, 'jpegenc', 0x0, 0x0, 0x460, 'ti.sdo.ce.image1.IIMGENC1')
[DSP] @3,157,671tk: [+0 T:0x9fc302d4] CE - Engine_open> Enter('local', 0x9fc33fac, 0x0)
[DSP] @3,157,718tk: [+0 T:0x9fc302d4] OM - Memory_alloc> Enter(size=0x34)
[DSP] @3,157,755tk: [+0 T:0x9fc302d4] OM - Memory_alloc> return (0x9fc34e68)
[DSP] @3,157,808tk: [+4 T:0x9fc302d4] CE - Engine_open> engine->server = 0x0
[DSP] @3,157,848tk: [+0 T:0x9fc302d4] CE - Engine_open> return(-1614590360)
[DSP] @3,157,932tk: [+0 T:0x9fc302d4] OM - Memory_alloc> Enter(size=0x34)
[DSP] @3,157,969tk: [+0 T:0x9fc302d4] OM - Memory_alloc> return (0x9fc34ea0)
[DSP] @3,158,013tk: [+0 T:0x9fc302d4] ti.sdo.ce.alg.Algorithm - Algorithm_create> Enter(fxns=0x9fc58d6c, idma3Fxns=0x0, iresFxns=0x0, params=0x0, attrs=0x9fc340c8)
[DSP] @3,158,090tk: [+0 T:0x9fc302d4] OM - Memory_alloc> Enter(size=0x10)
[DSP] @3,158,126tk: [+0 T:0x9fc302d4] OM - Memory_alloc> return (0x9fc34ed8)
[DSP] @3,158,539tk: [+0 T:0x9fc302d4] ti.sdo.ce.alg.Algorithm - Algorithm_create> return (0x9fc34ed8)
[DSP] @3,158,588tk: [+5 T:0x9fc302d4] CV - VISA_create> local codec created (name='jpegenc', handle=0x9fc34ed8)
[DSP] @3,158,643tk: [+0 T:0x9fc302d4] ti.sdo.ce.image1.IMGENC1 - IMGENC_create> return (0x9fc34ea0)
[DSP] @3,158,695tk: [+4 T:0x9fc302d4] OT - Thread_create > name: "jpegenc#0", pri: -1, stack size: 17192, stack seg: 0
@3,933,564us: [+0 T:0x40020100] CE - Engine_fwriteTrace> returning count [2254]
@3,933,595us: [+2 T:0x40020100] CE - Engine_createNode> Returning 0x499d8
@3,933,625us: [+5 T:0x40020100] CV - VISA_create> remote codec created (name='jpegenc', localQueueID=0x10001, remoteQueueID=0x0002)
@3,933,656us: [+0 T:0x40020100] ti.sdo.ce.image1.IMGENC1 - IMGENC_create> return (0x49990)
Success to create codec jpegenc
@3,933,686us: [+0 T:0x40020100] ti.sdo.ce.image1.IMGENC1 - IMGENC1_control> Enter (handle=0x49990, id=6, dynParams=0xbe88dc44 (size=0x20), status=0xbe88dba4 (size=0xa0)
@3,933,717us: [+4 T:0x40020100] CV - VISA_getMaxMsgSize(0x49990): returning 0x1000
@3,933,747us: [+5 T:0x40020100] CV - VISA_allocMsg> Allocating message for messageId=0x00020000
@3,933,778us: [+0 T:0x40020100] CV - VISA_call(visa=0x49990, msg=0x414e3880): messageId=0x00020000, command=0x1
@3,933,778us: [+0 T:0x40020100] OC - Comm_put> Enter(queue=0x2, msg=0x414e3880)
@3,933,808us: [+0 T:0x40020100] OC - Comm_put> return (0)
@3,933,839us: [+0 T:0x40020100] OC - Comm_get> Enter(queue=0x10001, msg=0xbe88db04, timeout=-1)
@3,934,144us: [+0 T:0x40020100] OC - Comm_get> MSGQ_get() status=0x8000, return (0)
@3,934,174us: [+3 T:0x40020100] CE - Engine_fwriteTrace(0x49518, '[DSP] ', 0x404b35e8)
@3,934,205us: [+3 T:0x40020100] CE - Engine_fwriteTrace(): requesting DSP trace @0x3c07fd ...
@3,934,235us: [+0 T:0x40020100] OC - Comm_put> Enter(queue=0x0, msg=0x414e2880)
@3,934,266us: [+0 T:0x40020100] OC - Comm_put> return (0)
@3,934,266us: [+0 T:0x40020100] OC - Comm_get> Enter(queue=0x10000, msg=0xbe88da7c, timeout=-1)
@3,934,327us: [+0 T:0x40020100] OC - Comm_get> MSGQ_get() status=0x8000, return (0)
@3,934,357us: [+3 T:0x40020100] CE - Engine_fwriteTrace> got 1091 chars @0x3c07fd (0 still avail, max: 32744, lost: 0)
[DSP] @4,206,464tk: [+5 T:0x9fc3531c] CN - NODE> 0x9fc34dd8(jpegenc#0) call(algHandle=0x9fc34ea0, msg=0x9ff04880); messageId=0x00020000
[DSP] @4,206,554tk: [+0 T:0x9fc3531c] ti.sdo.ce.image1.IMGENC1 - IMGENC1_control> Enter (handle=0x9fc34ea0, id=6, dynParams=0x9ff048b4 (size=0x20), status=0x9ff048d4 (size=0xa0)
[DSP] @4,206,652tk: [+5 T:0x9fc3531c] CV - VISA_enter(visa=0x9fc34ea0): algHandle = 0x9fc34ed8
[DSP] @4,206,703tk: [+0 T:0x9fc3531c] ti.sdo.ce.alg.Algorithm - Algorithm_activate> Enter(alg=0x9fc34ed8)
[DSP] @4,206,765tk: [+0 T:0x9fc3531c] ti.sdo.ce.alg.Algorithm - Algorithm_activate> Exit
[DSP] @4,206,817tk: [+5 T:0x9fc3531c] CV - VISA_exit(visa=0x9fc34ea0): algHandle = 0x9fc34ed8
[DSP] @4,206,867tk: [+0 T:0x9fc3531c] ti.sdo.ce.alg.Algorithm - Algorithm_deactivate> Enter(alg=0x9fc34ed8)
[DSP] @4,206,925tk: [+0 T:0x9fc3531c] ti.sdo.ce.alg.Algorithm - Algorithm_deactivate> Exit
[DSP] @4,206,968tk: [+0 T:0x9fc3531c] ti.sdo.ce.image1.IMGENC1 - IMGENC1_control> Exit (handle=0x9fc34ea0, retVal=0xffffffff)
[DSP] @4,207,033tk: [+5 T:0x9fc3531c] CN - NODE> returned from call(algHandle=0x9fc34ea0, msg=0x9ff04880); messageId=0x00020000
@4,268,708us: [+0 T:0x40020100] CE - Engine_fwriteTrace> returning count [1151]
@4,268,739us: [+0 T:0x40020100] CV - VISA_call Completed: messageId=0x00020000, command=0x1, return(status=-1)
@4,268,769us: [+5 T:0x40020100] CV - VISA_freeMsg(0x49990, 0x414e3880): Freeing message with messageId=0x00020000
@4,268,800us: [+0 T:0x40020100] ti.sdo.ce.image1.IMGENC1 - IMGENC1_control> Exit (handle=0x49990, retVal=0xffffffff)
status = -1
@4,268,800us: [+0 T:0x40020100] ti.sdo.ce.image1.IMGENC1 - IMGENC1_delete> Enter (handle=0x49990)
@4,268,830us: [+0 T:0x40020100] CV - VISA_delete(0x49990)
@4,268,861us: [+5 T:0x40020100] CV - VISA_delete> deleting codec (localQueue=0x10001, remoteQueue=0x2)
@4,268,861us: [+0 T:0x40020100] CE - Engine_ctrlNode(0x499d8, 0x499c8, 0x0)
@4,268,891us: [+0 T:0x40020100] OC - Comm_put> Enter(queue=0x2, msg=0x414e3880)
@4,268,922us: [+0 T:0x40020100] OC - Comm_put> return (0)
@4,268,983us: [+0 T:0x40020100] OC - Comm_get> Enter(queue=0x10001, msg=0x499c8, timeout=-1)
@4,269,013us: [+0 T:0x40020100] OC - Comm_get> MSGQ_get() status=0x8000, return (0)
@4,269,044us: [+0 T:0x40020100] CE - Engine_ctrlNode> Returning 0x0
@4,269,044us: [+0 T:0x40020100] CE - Engine_deleteNode(0x499d8)
@4,269,074us: [+0 T:0x40020100] OC - Comm_put> Enter(queue=0x0, msg=0x414e2880)
@4,269,105us: [+0 T:0x40020100] OC - Comm_put> return (0)
@4,269,105us: [+0 T:0x40020100] OC - Comm_get> Enter(queue=0x10000, msg=0xbe88db34, timeout=-1)
@4,269,685us: [+0 T:0x40020100] OC - Comm_get> MSGQ_get() status=0x8000, return (0)
@4,269,746us: [+5 T:0x40020100] CE - Engine_deleteNode(0x499d8): algName = jpegenc, algHandle = 0x9fc34ea0, stack size = 17192, stack used = 887(6%)
@4,269,776us: [+0 T:0x40020100] OC - Comm_delete> Enter (comm=0x49a00)
@4,269,898us: [+0 T:0x40020100] OM - Memory_free> Enter(0x49a00, 0x4)
@4,269,929us: [+0 T:0x40020100] OM - Memory_free> return (0x1)
@4,269,959us: [+0 T:0x40020100] OC - Comm_delete> return
@4,269,959us: [+0 T:0x40020100] OM - Memory_free> Enter(0x499d8, 0x20)
@4,269,990us: [+0 T:0x40020100] OM - Memory_free> return (0x1)
@4,270,020us: [+0 T:0x40020100] OC - Comm_free> Enter (msg=0x414e3880)
@4,270,051us: [+0 T:0x40020100] OC - Comm_free> return (0)
@4,270,051us: [+0 T:0x40020100] OM - Memory_free> Enter(0x499c8, 0x4)
@4,270,081us: [+0 T:0x40020100] OM - Memory_free> return (0x1)
@4,270,081us: [+0 T:0x40020100] OM - Memory_free> Enter(0x49990, 0x34)
@4,270,112us: [+0 T:0x40020100] OM - Memory_free> return (0x1)
@4,270,142us: [+0 T:0x40020100] ti.sdo.ce.image1.IMGENC1 - IMGENC1_delete> return
@4,270,142us: [+0 T:0x40020100] CE - Engine_close(0x49518)
@4,270,173us: [+3 T:0x40020100] CE - Engine_fwriteTrace(0x49518, '[DSP] ', 0x404b35e8)
@4,270,203us: [+3 T:0x40020100] CE - Engine_fwriteTrace(): requesting DSP trace @0x41287b ...
@4,270,203us: [+0 T:0x40020100] OC - Comm_put> Enter(queue=0x0, msg=0x414e2880)
@4,270,234us: [+0 T:0x40020100] OC - Comm_put> return (0)
@4,270,264us: [+0 T:0x40020100] OC - Comm_get> Enter(queue=0x10000, msg=0xbe88db3c, timeout=-1)
@4,270,325us: [+0 T:0x40020100] OC - Comm_get> MSGQ_get() status=0x8000, return (0)
@4,270,356us: [+3 T:0x40020100] CE - Engine_fwriteTrace> got 1643 chars @0x41287b (0 still avail, max: 32744, lost: 0)
[DSP] @5,253,691tk: [+0 T:0x9fc3531c] CN - NODE_EXECFXN(0x9fc34dd8): jpegenc#0 exiting per request ...
[DSP] @5,254,711tk: [+0 T:0x9fc302d4] CN - NODE_delete(0x9fc34dd8): jpegenc#0
[DSP] @5,254,783tk: [+0 T:0x9fc302d4] ti.sdo.ce.image1.IMGENC1 - IMGENC1_delete> Enter (handle=0x9fc34ea0)
[DSP] @5,254,838tk: [+0 T:0x9fc302d4] CV - VISA_delete(0x9fc34ea0)
[DSP] @5,254,876tk: [+5 T:0x9fc302d4] CV - VISA_delete> deleting codec (localQueue=0xffff, remoteQueue=0xffff)
[DSP] @5,254,928tk: [+5 T:0x9fc302d4] CV - VISA_delete> deleting codec 0x9fc34ed8
[DSP] @5,254,972tk: [+0 T:0x9fc302d4] ti.sdo.ce.alg.Algorithm - Algorithm_delete> Enter(alg=0x9fc34ed8)
[DSP] @5,255,068tk: [+0 T:0x9fc302d4] OM - Memory_free> Enter(addr=0x9fc34ed8, size=16)
[DSP] @5,255,115tk: [+0 T:0x9fc302d4] OM - Memory_free> return (0x1)
[DSP] @5,255,149tk: [+0 T:0x9fc302d4] ti.sdo.ce.alg.Algorithm - Algorithm_delete> Exit
[DSP] @5,255,189tk: [+0 T:0x9fc302d4] OM - Memory_free> Enter(addr=0x9fc34ea0, size=52)
[DSP] @5,255,234tk: [+0 T:0x9fc302d4] OM - Memory_free> return (0x1)
[DSP] @5,255,268tk: [+0 T:0x9fc302d4] ti.sdo.ce.image1.IMGENC1 - IMGENC1_delete> return
[DSP] @5,255,312tk: [+0 T:0x9fc302d4] OM - Memory_free> Enter(addr=0x9fc34df8, size=36)
[DSP] @5,255,356tk: [+0 T:0x9fc302d4] OM - Memory_free> return (0x1)
[DSP] @5,255,390tk: [+0 T:0x9fc302d4] OM - Memory_free> Enter(addr=0x9fc34dd8, size=32)
[DSP] @5,255,434tk: [+0 T:0x9fc302d4] OM - Memory_free> return (0x1)
[DSP] @5,255,471tk: [+0 T:0x9fc302d4] OM - Memory_free> Enter(addr=0x9fc34dc8, size=10)
[DSP] @5,255,516tk: [+0 T:0x9fc302d4] OM - Memory_free> return (0x1)
[DSP] @5,255,549tk: [+0 T:0x9fc302d4] OM - Memory_free> Enter(addr=0x9fc34db0, size=24)
[DSP] @5,255,594tk: [+0 T:0x9fc302d4] OM - Memory_free> return (0x1)
@4,604,951us: [+0 T:0x40020100] CE - Engine_fwriteTrace> returning count [1769]
@4,604,981us: [+0 T:0x40020100] CS - Server_disconnectTrace('0x49518', 0x0)
@4,605,012us: [+0 T:0x40020100] CS - Server_disconnectTrace> return(0)
@4,605,042us: [+0 T:0x40020100] OC - Comm_free> Enter (msg=0x414e2880)
@4,605,073us: [+0 T:0x40020100] OC - Comm_free> return (0)
@4,605,073us: [+0 T:0x40020100] OC - Comm_delete> Enter (comm=0x49930)
@4,605,164us: [+0 T:0x40020100] OM - Memory_free> Enter(0x49930, 0x4)
@4,605,195us: [+0 T:0x40020100] OM - Memory_free> return (0x1)
@4,605,225us: [+0 T:0x40020100] OC - Comm_delete> return
@4,605,225us: [+0 T:0x40020100] OC - Comm_release> Enter(queue=0x0)
@4,605,256us: [+0 T:0x40020100] OC - Comm_release> return (0)
@4,605,286us: [+0 T:0x40020100] CE - rserverClose(0x486b0), count = 1
@4,605,286us: [+0 T:0x40020100] OP - Processor_delete> Enter(proc=0x49550)
@4,605,317us: [+0 T:0x40020100] OP - doCmd> Enter (cmdId=2, proc=0x49550)
@4,605,347us: [+0 T:0x40020100] ti.sdo.ce.osal.Sem - Entered Sem_post> sem[0x491c0]
@4,605,378us: [+0 T:0x40cd2490] ti.sdo.ce.osal.Sem - Leaving Sem_pend> sem[0x491c0] status[0]
@4,605,408us: [+0 T:0x40cd2490] OP - getCmd_d> Exit (result=2)
@4,605,439us: [+0 T:0x40cd2490] OP - Processor_delete_d> Enter (proc=0x49550)
@4,605,439us: [+0 T:0x40cd2490] ti.sdo.ce.ipc.Power - Power_disconnect> Enter (handle=0x49578)
@4,605,470us: [+2 T:0x40cd2490] ti.sdo.ce.ipc.Power - Power_disconnect> Calling LPM_disconnect to disconnect from the DSP power handler...
@4,605,500us: [+0 T:0x40cd2490] ti.sdo.ce.ipc.Power - Power_disconnect> return (0)
@4,605,531us: [+2 T:0x40cd2490] OP - Processor_delete_d> Closing remote transport...
@4,605,683us: [+2 T:0x40cd2490] OP - Processor_delete_d> Stopping DSP...
@4,605,744us: [+2 T:0x40cd2490] OP - Processor_delete_d> Closing pool...
@4,605,805us: [+2 T:0x40cd2490] OP - Processor_delete_d> Detaching from DSP...
@4,607,484us: [+2 T:0x40cd2490] OP - Processor_delete_d> Destroying DSP... (object, that is)
@4,607,728us: [+0 T:0x40cd2490] ti.sdo.ce.ipc.Power - Power_off> Enter (handle=0x49578)
@4,607,758us: [+2 T:0x40cd2490] ti.sdo.ce.ipc.Power - Power_off> Turning off DSP power...
@4,607,850us: [+2 T:0x40cd2490] ti.sdo.ce.ipc.Power - Power_off> Closing Local Power Manager object...
@4,607,880us: [+0 T:0x40cd2490] ti.sdo.ce.ipc.Power - Power_off> return (0)
@4,607,911us: [+0 T:0x40cd2490] OM - Memory_free> Enter(0x495b0, 0x0)
@4,607,941us: [+0 T:0x40cd2490] OM - Memory_free> return (0x1)
@4,942,506us: [+0 T:0x40cd2490] OP - Processor_delete_d> return
@4,942,536us: [+0 T:0x40cd2490] ti.sdo.ce.osal.Sem - Entered Sem_post> sem[0x491d8]
@4,942,536us: [+0 T:0x40cd2490] ti.sdo.ce.osal.Sem - Leaving Sem_post> sem[0x491d8]
@4,942,567us: [+0 T:0x40cd2490] OP - getCmd_d> Enter (proc=0x40cd1dd8)
@4,942,597us: [+0 T:0x40cd2490] ti.sdo.ce.osal.Sem - Entered Sem_pend> sem[0x491c0] timeout[0xffffffff]
@4,942,628us: [+0 T:0x40020100] ti.sdo.ce.osal.Sem - Leaving Sem_post> sem[0x491c0]
@4,942,658us: [+0 T:0x40020100] ti.sdo.ce.osal.Sem - Entered Sem_pend> sem[0x491d8] timeout[0xffffffff]
@4,942,658us: [+0 T:0x40020100] ti.sdo.ce.osal.Sem - Leaving Sem_pend> sem[0x491d8] status[0]
@4,942,689us: [+0 T:0x40020100] OP - doCmd> Exit (result=1)
@4,942,719us: [+1 T:0x40020100] OP - Processor_delete(0x49550) freeing object ...
@4,942,719us: [+0 T:0x40020100] OM - Memory_free> Enter(0x49550, 0x24)
@4,942,750us: [+0 T:0x40020100] OM - Memory_free> return (0x1)
@4,942,750us: [+0 T:0x40020100] OP - Processor_delete> return.
@4,942,780us: [+0 T:0x40020100] CE - rserverClose(0x486b0) done.
@4,942,811us: [+0 T:0x40020100] OM - Memory_free> Enter(0x49518, 0x34)
@4,942,811us: [+0 T:0x40020100] OM - Memory_free> return (0x1)
@4,942,841us: [+0 T:0x40020100] CE - Engine_close exit
@4,942,872us: [+0 T:0x40020100] OG - Global_exit> enter
@4,942,872us: [+2 T:0x40020100] OG - Global_exit> calling function *0xca2c()...
@4,942,902us: [+2 T:0x40020100] OG - Global_exit> calling function *0xe134()...
@4,942,933us: [+2 T:0x40020100] OG - Global_exit> calling function *0x108c4()...
@4,942,963us: [+0 T:0x40020100] OM - Memory_free> Enter(0x49458, 0x18)
@4,942,994us: [+0 T:0x40020100] OM - Memory_free> return (0x1)
@4,943,024us: [+0 T:0x40020100] OM - Memory_free> Enter(0x49478, 0x18)
@4,943,024us: [+0 T:0x40020100] OM - Memory_free> return (0x1)
@4,943,055us: [+0 T:0x40020100] OM - Memory_free> Enter(0x49498, 0x18)
@4,943,055us: [+0 T:0x40020100] OM - Memory_free> return (0x1)
@4,943,085us: [+2 T:0x40020100] OG - Global_exit> calling function *0x1cf8c()...
@4,943,116us: [+2 T:0x40020100] OG - Global_exit> calling function *0x143cc()...
@4,943,116us: [+2 T:0x40020100] OG - Global_exit> calling function *0x1a638()...
@4,943,147us: [+2 T:0x40020100] OG - Global_exit> calling function *0x17d48()...
@4,943,177us: [+0 T:0x40020100] OP - doCmd> Enter (cmdId=3, proc=0x0)
@4,943,177us: [+0 T:0x40020100] ti.sdo.ce.osal.Sem - Entered Sem_post> sem[0x491c0]
@4,943,208us: [+0 T:0x40cd2490] ti.sdo.ce.osal.Sem - Leaving Sem_pend> sem[0x491c0] status[0]
@4,943,238us: [+0 T:0x40cd2490] OP - getCmd_d> Exit (result=3)
@4,943,269us: [+0 T:0x40cd2490] ti.sdo.ce.osal.Sem - Entered Sem_post> sem[0x491d8]
@4,943,269us: [+0 T:0x40cd2490] ti.sdo.ce.osal.Sem - Leaving Sem_post> sem[0x491d8]
@4,943,391us: [+0 T:0x40020100] ti.sdo.ce.osal.Sem - Leaving Sem_post> sem[0x491c0]
@4,943,421us: [+0 T:0x40020100] ti.sdo.ce.osal.Sem - Entered Sem_pend> sem[0x491d8] timeout[0xffffffff]
@4,943,452us: [+0 T:0x40020100] ti.sdo.ce.osal.Sem - Leaving Sem_pend> sem[0x491d8] status[0]
@4,943,452us: [+0 T:0x40020100] OP - doCmd> Exit (result=1)
@4,943,482us: [+0 T:0x40020100] OT - Thread_delete> Enter (task=0x49210)
@4,943,513us: [+4 T:0x40020100] OT - Thread_delete> pthread_cancel (0x3)
@4,943,543us: [+4 T:0x40020100] OT - Thread_delete> pthread_join (0x0)
@4,943,543us: [+0 T:0x40020100] OM - Memory_free> Enter(0x49210, 0x64)
@4,943,574us: [+0 T:0x40020100] OM - Memory_free> return (0x1)
@4,943,574us: [+0 T:0x40020100] OT - Thread_delete> Exit (task=0x49210)
@4,943,604us: [+0 T:0x40020100] ti.sdo.ce.osal.Sem - Entered Sem_delete> sem[0x491c0]
@4,943,635us: [+0 T:0x40020100] OM - Memory_free> Enter(0x491c0, 0x14)
@4,943,665us: [+0 T:0x40020100] OM - Memory_free> return (0x1)
@5,278,046us: [+0 T:0x40020100] ti.sdo.ce.osal.Sem - Leaving Sem_delete>
@5,278,107us: [+0 T:0x40020100] ti.sdo.ce.osal.Sem - Entered Sem_delete> sem[0x491d8]
@5,278,107us: [+0 T:0x40020100] OM - Memory_free> Enter(0x491d8, 0x14)
@5,278,138us: [+0 T:0x40020100] OM - Memory_free> return (0x1)
@5,278,168us: [+0 T:0x40020100] ti.sdo.ce.osal.Sem - Leaving Sem_delete>
@5,278,168us: [+0 T:0x40020100] OM - Memory_free> Enter(0x491f0, 0x18)
@5,278,199us: [+0 T:0x40020100] OM - Memory_free> return (0x1)
@5,278,230us: [+2 T:0x40020100] OG - Global_exit> calling function *0x197f0()...
@5,278,230us: [+2 T:0x40020100] OG - Global_exit> calling function *0x1ca9c()...
@5,278,260us: [+2 T:0x40020100] OG - Global_exit> calling function *0x1a0ec()...
@5,278,291us: [+0 T:0x40020100] OM - Memory_free> Enter(0x49140, 0x18)
@5,278,321us: [+0 T:0x40020100] OM - Memory_free> return (0x1)
@5,278,321us: [+2 T:0x40020100] OG - Global_exit> calling function *0x1b2c0()...
@5,278,352us: [+0 T:0x40020100] OM - Memory_free> Enter(0x49110, 0x18)
@5,278,382us: [+0 T:0x40020100] OM - Memory_free> return (0x1)
@5,278,413us: [+2 T:0x40020100] OG - Global_exit> calling function *0x1d438()...
@5,278,413us: [+2 T:0x40020100] OG - Global_exit> calling function *0x1dfec()...
@5,278,443us: [+2 T:0x40020100] OG - Global_exit> calling function *0x1d398()...
请问,我出现该问题的原因是什么呢?