Error voting WF activity - An item with the same key has already been added.

Hi,

I'm voting to complete an activity of a WF, but when I complete the activity I get the error in the image below (>An item with the same key has already been added.). My question is how I can find what is the item that get me the error? 

thanks

Parents
  • Hi Laura,

    I haven't seen this issue before with a standard Workflow. Could you check the Workflow Map to confirm if there are any server events running when this activity is completed? It's possible a method running in one of these events is the cause of the error.

    Additionally, ou can check the AML that's being applied directly before this error by enabling the server to output logs of all the AML requests coming in. You can follow the steps below to do that. 

    1. Log in to your Aras Innovator instance and get to the step just before the error is thrown
      1. In this case, it seems like you should fill out the workflow completion form, but do not apply it
    2. Navigate to the install path of your Aras Innovator instance (By default C:\Program Files (x86)\Aras\Innovator
    3. Go to \Innovator\Server\logs\ and make sure to delete any existing logs if there are any
    4. Go back to the root of your install path and open InnovatorServerConfig.xml
    5. Near the top of this file make the following edit to enable logs
      1. <operating_parameter key="debug_log_flag" value="true"/>
    6. Perform the action in Innovator that throws the error
      1. In this case, click the apply the button on the workflow completion form
    7. Disable the logs by reverting the change to the InnovatorServerConfig.xml, so they do not bloat your server
      1. <operating_parameter key="debug_log_flag" value="false"/>
    8. Go back to \Innovator\Server\logs\ and check the files here for the error that's being thrown

    There may be several files, but they should be relatively small. When you find the error being thrown, you can check directly above that error in the log to see what AML caused it.

    Chris

    Christopher Gillis

    Aras Labs Software Engineer

  • 2019-05-24-18-45-25-90-19A76F7623774AF09CD2E5D7C8FE27FE.xml
    <LOGFILE>
    <event time="2019-05-24 18:45:25Z" reason="soap_action" TickCount="741734250" dt="32" message="ApplyAML" />
    <event time="2019-05-24 18:45:25Z" reason="requestDom" TickCount="741734250" dt="0" />
    <SOAP-ENV:Envelope xmlns:SOAP-ENV="http://schemas.xmlsoap.org/soap/envelope/">
     <SOAP-ENV:Body>
      <ApplyAML>
       <AML>
        <Item type="Activity" action="EvaluateActivity">
         <Activity>7A9E6AFD8A984E13A6A4ABCC876B6D1A</Activity>
         <ActivityAssignment>45ADB1D4F301497D92AC0A6468245594</ActivityAssignment>
         <Paths>
          <Path id="DE8930F44F0641AF9F8FE8F0F9B6D585"><![CDATA[Complete]]></Path>
         </Paths>
         <DelegateTo>0</DelegateTo>
         <Tasks>
          <Task id="ABA86C2978FD4037AD98D6E03E0381FB" completed="0">
          </Task>
          <Task id="4E5769B0F916432786EDD640674437A2" completed="0">
          </Task>
         </Tasks>
         <Variables>
         </Variables>
         <Authentication mode="">
         </Authentication>
         <Comments>
         </Comments>
         <Complete>1</Complete>
        </Item>
       </AML>
      </ApplyAML>
     </SOAP-ENV:Body>
    </SOAP-ENV:Envelope>
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734421" dt="171" message="GetLCMapFromCache:BD1529204922428C997E86B3BDEA4646:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734421" dt="0" message="Aras.Server.Core.LifeCycleMapInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734437" dt="16" message="GetRelListFromCache:937CE47DE2854308BE6FF5AB1CFB19D4:True:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734437" dt="0" message="Aras.Server.Core.RelTypesList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734468" dt="31" message="GetRelListFromCache:85924010F3184E77B24E9142FDBB481B:True:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734468" dt="0" message="Aras.Server.Core.RelTypesList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734484" dt="16" message="GetRelListFromCache:BD4A250787A742A484C7B174A4AED1E2:True:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734484" dt="0" message="Aras.Server.Core.RelTypesList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734500" dt="16" message="GetRelListFromCache:46BDE53304404C28B5C45610E41C1DD5:True:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734500" dt="0" message="Aras.Server.Core.RelTypesList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734515" dt="15" message="GetRelListFromCache:34682D3EB66141ECACC8796C9D3A42B8:True:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734515" dt="0" message="Aras.Server.Core.RelTypesList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734546" dt="31" message="GetItemTypeIdFromCache:Transition EMail:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734546" dt="0" message="Aras.Server.Core.ItemTypeIdInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734609" dt="63" message="GetRelListFromCache:EB4ADB2BC83C410FB265CB42ED5C633B:True:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734609" dt="0" message="Aras.Server.Core.RelTypesList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734671" dt="62" message="GetServerEventsFromCache:B7DF834246F24F10BC9B91056D828538:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734671" dt="0" message="Aras.Server.Core.MetaDataInfo.ServerEventsList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734671" dt="0" message="GetServerEventsFromCache:CBA93BEFFB4F499CAF122CB79E204983:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734671" dt="0" message="Aras.Server.Core.MetaDataInfo.ServerEventsList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734671" dt="0" message="GetLCSInfoFromCache:FFFF270B50B749D4B9F31DC207BB3996:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734671" dt="0" message="Aras.Server.Core.LifeCycleStateInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734671" dt="0" message="GetLCSInfoFromCache:FB0688A0DD8B4FB2811B4E5F5D128617:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734671" dt="0" message="Aras.Server.Core.LifeCycleStateInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734671" dt="0" message="GetLCSInfoFromCache:AEE8C1553B3A4C50AB67EEDE69CBBA9C:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734671" dt="0" message="Aras.Server.Core.LifeCycleStateInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734671" dt="0" message="GetLCMapFromCache:A84D251567A0468F98159E04EE8CDFA5:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734671" dt="0" message="Aras.Server.Core.LifeCycleMapInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734687" dt="16" message="GetMethodFromCache:E715E11DCD8F49898C2DE499020027FA:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734687" dt="0" message="Aras.Server.Core.CacheMethodInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734703" dt="16" message="GetHistoryTemplateInfoFromCache:3BC16EF9E52B4F9792AB76BCE0492F29:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734703" dt="0" message="Aras.Server.Core.HistoryTemplateInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734703" dt="0" message="GetPropertiesListFromCache:CBA93BEFFB4F499CAF122CB79E204983:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734703" dt="0" message="Aras.Server.Core.PropertiesList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734718" dt="15" message="GetRelListFromCache:CBA93BEFFB4F499CAF122CB79E204983:False:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734718" dt="0" message="Aras.Server.Core.RelTypesList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734765" dt="47" message="GetListFromCache:15B69C0E360D47FD8B482C1144EF7173:id:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734765" dt="0" message="Aras.Server.Core.ListInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734765" dt="0" message="GetMethodIDByNameFromCache:PE_ChangeItemTransition:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734765" dt="0" message="Aras.Server.Core.MethodIdInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734781" dt="16" message="GetItemTypeIdFromCache:Express ECO Affected Item:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734781" dt="0" message="Aras.Server.Core.ItemTypeIdInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734781" dt="0" message="GetServerEventsFromCache:FFE118760ADB44FC984FBE0B633414FC:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734781" dt="0" message="Aras.Server.Core.MetaDataInfo.ServerEventsList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734781" dt="0" message="GetRelListFromCache:FFE118760ADB44FC984FBE0B633414FC:False:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734781" dt="0" message="Aras.Server.Core.RelTypesList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734796" dt="15" message="GetPropertiesListFromCache:FFE118760ADB44FC984FBE0B633414FC:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734796" dt="0" message="Aras.Server.Core.PropertiesList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734796" dt="0" message="AllowedPermissionsList:FFE118760ADB44FC984FBE0B633414FC:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734796" dt="0" message="Aras.Server.Core.PermissionsList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734796" dt="0" message="AllowedPermissionsList:BFAAB0F6838D4F80BF12CB328FF5B097:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734796" dt="0" message="Aras.Server.Core.PermissionsList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734812" dt="16" message="GetPropertiesListFromCache:BFAAB0F6838D4F80BF12CB328FF5B097:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734812" dt="0" message="Aras.Server.Core.PropertiesList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734906" dt="94" message="GetItemTypeIdFromCache:Affected Item:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734906" dt="0" message="Aras.Server.Core.ItemTypeIdInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734906" dt="0" message="GetServerEventsFromCache:BFAAB0F6838D4F80BF12CB328FF5B097:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734906" dt="0" message="Aras.Server.Core.MetaDataInfo.ServerEventsList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734906" dt="0" message="GetRelListFromCache:BFAAB0F6838D4F80BF12CB328FF5B097:False:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734906" dt="0" message="Aras.Server.Core.RelTypesList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734921" dt="15" message="GetPropertiesListFromCache:198BF0BCCC364EE29F56434D803D5F1E:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734921" dt="0" message="Aras.Server.Core.PropertiesList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734921" dt="0" message="AllowedPermissionsList:198BF0BCCC364EE29F56434D803D5F1E:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734921" dt="0" message="Aras.Server.Core.PermissionsList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735187" dt="266" message="GetServerEventsFromCache:198BF0BCCC364EE29F56434D803D5F1E:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735187" dt="0" message="Aras.Server.Core.MetaDataInfo.ServerEventsList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735187" dt="0" message="GetServerEventsFromCache:4F1AC04A2B484F3ABA4E20DB63808A88:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735187" dt="0" message="Aras.Server.Core.MetaDataInfo.ServerEventsList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735203" dt="16" message="GetRelListFromCache:4F1AC04A2B484F3ABA4E20DB63808A88:False:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735203" dt="0" message="Aras.Server.Core.RelTypesList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735218" dt="15" message="GetPropertiesListFromCache:4F1AC04A2B484F3ABA4E20DB63808A88:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735218" dt="0" message="Aras.Server.Core.PropertiesList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735218" dt="0" message="AllowedPermissionsList:4F1AC04A2B484F3ABA4E20DB63808A88:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735218" dt="0" message="Aras.Server.Core.PermissionsList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735218" dt="0" message="AllowedPermissionsList:2C6C641717EA48C2AE6548449ABAF79F:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735218" dt="0" message="Aras.Server.Core.PermissionsList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735218" dt="0" message="AllowedPermissionsList:34CAB79C36994D3692D9D8D20BF7894F:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735218" dt="0" message="Aras.Server.Core.PermissionsList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735250" dt="32" message="GetLCSInfoFromCache:BE7478E822444326A2EC9F1E11A88963:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735250" dt="0" message="Aras.Server.Core.LifeCycleStateInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735250" dt="0" message="GetLCSInfoFromCache:42BB3B183A7748C3B4AA9D33F7BF70AC:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735250" dt="0" message="Aras.Server.Core.LifeCycleStateInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735250" dt="0" message="GetListFromCache:CAE8E3D4280F4804A9DFE5C527C1F42C:id:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735250" dt="0" message="Aras.Server.Core.ListInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735250" dt="0" message="GetListFromCache:E76C49F948B64B918282E2812EFDFAD0:id:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735250" dt="0" message="Aras.Server.Core.ListInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735250" dt="0" message="GetListFromCache:9FEC936F59F14FECAA3621F726FBAAF2:id:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735250" dt="0" message="Aras.Server.Core.ListInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735265" dt="15" message="GetListFromCache:456865E4F30946DE8C7B49D1E011CC25:id:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735265" dt="0" message="Aras.Server.Core.ListInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735265" dt="0" message="GetListFromCache:540DD8228C8043BD905BF401D245926E:id:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735265" dt="0" message="Aras.Server.Core.ListInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735265" dt="0" message="GetListFromCache:F7553D600D57489BB81309E32835AFEC:id:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735265" dt="0" message="Aras.Server.Core.ListInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735265" dt="0" message="GetListFromCache:2BE5CDEBF2114CE88DEF9455ECAF785B:id:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735265" dt="0" message="Aras.Server.Core.ListInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735312" dt="47" message="GetLCSInfoFromCache:72A2322564FE4193933CFB5339487A06:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735312" dt="0" message="Aras.Server.Core.LifeCycleStateInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735312" dt="0" message="GetListFromCache:5C72C69E1762447FAB17F8AD2B3F5DFC:id:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735312" dt="0" message="Aras.Server.Core.ListInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735312" dt="0" message="GetListFromCache:4F0EABD6883348A5BF3CD4C6AAA2873D:id:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735312" dt="0" message="Aras.Server.Core.ListInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735328" dt="16" message="GetListFromCache:50AB0A69063D4AFBA7E4CADFDD444C8A:id:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735328" dt="0" message="Aras.Server.Core.ListInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735328" dt="0" message="GetLCSInfoFromCache:AA93A121BC7346C4907F69820303D2A4:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735328" dt="0" message="Aras.Server.Core.LifeCycleStateInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735328" dt="0" message="GetLCMapFromCache:E337EBF706FA4172B2CD1A6487E00875:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735328" dt="0" message="Aras.Server.Core.LifeCycleMapInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735328" dt="0" message="GetMethodFromCache:D01D8204028D45C38DD33C70F1EFD9C6:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735328" dt="0" message="Aras.Server.Core.CacheMethodInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735328" dt="0" message="GetMethodFromCache:4AD4E5A249AE4492B7FC1D8B548617BB:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735328" dt="0" message="Aras.Server.Core.CacheMethodInfo" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735640" dt="312" message="GetMethodIDByNameFromCache:FPLCBeforePublish:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735640" dt="0" message="Aras.Server.Core.MethodIdInfo" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735640" dt="0" message="GetItemTypeIdFromCache:Life Cycle Synchronizer:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735640" dt="0" message="Aras.Server.Core.ItemTypeIdInfo" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735640" dt="0" message="GetServerEventsFromCache:2DC7E1B4E74D402B8266AD7559A30AB0:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735640" dt="0" message="Aras.Server.Core.MetaDataInfo.ServerEventsList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735640" dt="0" message="GetRelListFromCache:2DC7E1B4E74D402B8266AD7559A30AB0:False:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735640" dt="0" message="Aras.Server.Core.RelTypesList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735656" dt="16" message="GetPropertiesListFromCache:2DC7E1B4E74D402B8266AD7559A30AB0:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735656" dt="0" message="Aras.Server.Core.PropertiesList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735656" dt="0" message="AllowedPermissionsList:2DC7E1B4E74D402B8266AD7559A30AB0:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735656" dt="0" message="Aras.Server.Core.PermissionsList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735656" dt="0" message="AllowedPermissionsList:AC32527D85604A4D9FC9107C516AEF47:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735656" dt="0" message="Aras.Server.Core.PermissionsList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735671" dt="15" message="GetItemTypeIdFromCache:Life Cycle State Accepted:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735671" dt="0" message="Aras.Server.Core.ItemTypeIdInfo" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735671" dt="0" message="GetServerEventsFromCache:E0E10EC641B4488895640BECADB43DBB:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735671" dt="0" message="Aras.Server.Core.MetaDataInfo.ServerEventsList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735671" dt="0" message="GetRelListFromCache:E0E10EC641B4488895640BECADB43DBB:False:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735671" dt="0" message="Aras.Server.Core.RelTypesList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735671" dt="0" message="GetPropertiesListFromCache:E0E10EC641B4488895640BECADB43DBB:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735671" dt="0" message="Aras.Server.Core.PropertiesList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735671" dt="0" message="AllowedPermissionsList:E0E10EC641B4488895640BECADB43DBB:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735671" dt="0" message="Aras.Server.Core.PermissionsList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735687" dt="16" message="GetItemTypeIdFromCache:Life Cycle State Allow:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735687" dt="0" message="Aras.Server.Core.ItemTypeIdInfo" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735687" dt="0" message="GetServerEventsFromCache:87BD109743F342599992B508154DD2BD:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735687" dt="0" message="Aras.Server.Core.MetaDataInfo.ServerEventsList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735687" dt="0" message="GetRelListFromCache:87BD109743F342599992B508154DD2BD:False:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735687" dt="0" message="Aras.Server.Core.RelTypesList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735703" dt="16" message="GetPropertiesListFromCache:87BD109743F342599992B508154DD2BD:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735703" dt="0" message="Aras.Server.Core.PropertiesList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735703" dt="0" message="AllowedPermissionsList:87BD109743F342599992B508154DD2BD:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735703" dt="0" message="Aras.Server.Core.PermissionsList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735703" dt="0" message="AllowedPermissionsList:C6A89FDE1294451497801DF78341B473:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735703" dt="0" message="Aras.Server.Core.PermissionsList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735750" dt="47" message="GetItemTypeIdFromCache:Life Cycle State Deny:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735750" dt="0" message="Aras.Server.Core.ItemTypeIdInfo" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735750" dt="0" message="GetServerEventsFromCache:C6379FCFFCD449E2933C00E98BC8C929:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735750" dt="0" message="Aras.Server.Core.MetaDataInfo.ServerEventsList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735750" dt="0" message="GetRelListFromCache:C6379FCFFCD449E2933C00E98BC8C929:False:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735750" dt="0" message="Aras.Server.Core.RelTypesList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735765" dt="15" message="GetPropertiesListFromCache:C6379FCFFCD449E2933C00E98BC8C929:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735765" dt="0" message="Aras.Server.Core.PropertiesList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735765" dt="0" message="AllowedPermissionsList:C6379FCFFCD449E2933C00E98BC8C929:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735765" dt="0" message="Aras.Server.Core.PermissionsList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735812" dt="47" message="GetItemTypeIdFromCache:Part CAD:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735812" dt="0" message="Aras.Server.Core.ItemTypeIdInfo" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735812" dt="0" message="GetServerEventsFromCache:935DF68BCFD849EBB5C3A528F04C5B5B:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735812" dt="0" message="Aras.Server.Core.MetaDataInfo.ServerEventsList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735812" dt="0" message="GetRelListFromCache:935DF68BCFD849EBB5C3A528F04C5B5B:False:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735812" dt="0" message="Aras.Server.Core.RelTypesList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735828" dt="16" message="GetPropertiesListFromCache:935DF68BCFD849EBB5C3A528F04C5B5B:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735828" dt="0" message="Aras.Server.Core.PropertiesList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735828" dt="0" message="AllowedPermissionsList:935DF68BCFD849EBB5C3A528F04C5B5B:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735828" dt="0" message="Aras.Server.Core.PermissionsList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735828" dt="0" message="GetServerEventsFromCache:CCF205347C814DD1AF056875E0A880AC:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735828" dt="0" message="Aras.Server.Core.MetaDataInfo.ServerEventsList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735828" dt="0" message="GetRelListFromCache:CCF205347C814DD1AF056875E0A880AC:False:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735828" dt="0" message="Aras.Server.Core.RelTypesList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735843" dt="15" message="GetPropertiesListFromCache:CCF205347C814DD1AF056875E0A880AC:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735843" dt="0" message="Aras.Server.Core.PropertiesList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735859" dt="16" message="GetLCSInfoFromCache:E4F115AAA1FA4D9FB053915171F49007:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735859" dt="0" message="Aras.Server.Core.LifeCycleStateInfo" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735859" dt="0" message="GetListFromCache:11A953CA5A5E4BCD8EC9758C7E4B6E92:id:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735859" dt="0" message="Aras.Server.Core.ListInfo" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735875" dt="16" message="GetServerEventsFromCache:2A5BB1A93BDC436B824B9FFE6DB89553:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735875" dt="0" message="Aras.Server.Core.MetaDataInfo.ServerEventsList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735875" dt="0" message="GetServerEventsFromCache:5E9C5A12CC58413A8670CF4003C57848:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735875" dt="0" message="Aras.Server.Core.MetaDataInfo.ServerEventsList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735875" dt="0" message="GetRelListFromCache:5E9C5A12CC58413A8670CF4003C57848:False:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735875" dt="0" message="Aras.Server.Core.RelTypesList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735890" dt="15" message="GetPropertiesListFromCache:5E9C5A12CC58413A8670CF4003C57848:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735890" dt="0" message="Aras.Server.Core.PropertiesList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735890" dt="0" message="AllowedPermissionsList:5E9C5A12CC58413A8670CF4003C57848:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735890" dt="0" message="Aras.Server.Core.PermissionsList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735890" dt="0" message="GetItemTypeIdFromCache:CAD Structure:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735890" dt="0" message="Aras.Server.Core.ItemTypeIdInfo" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735890" dt="0" message="GetServerEventsFromCache:2812BEB188644E7FB3BEE526FD62032A:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735890" dt="0" message="Aras.Server.Core.MetaDataInfo.ServerEventsList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735890" dt="0" message="GetRelListFromCache:2812BEB188644E7FB3BEE526FD62032A:False:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735890" dt="0" message="Aras.Server.Core.RelTypesList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735906" dt="16" message="GetPropertiesListFromCache:2812BEB188644E7FB3BEE526FD62032A:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735906" dt="0" message="Aras.Server.Core.PropertiesList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735906" dt="0" message="AllowedPermissionsList:2812BEB188644E7FB3BEE526FD62032A:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735906" dt="0" message="Aras.Server.Core.PermissionsList" />
    <event time="2019-05-24 18:45:28Z" reason="RollBackAllServerCaches" TickCount="741736375" dt="469" message="99 keys" />
    <event time="2019-05-24 18:45:28Z" reason="performance" TickCount="741736375" dt="0" message="2157" />
    <event time="2019-05-24 18:45:28Z" reason="responseDom" TickCount="741736375" dt="0" />
    <SOAP-ENV:Envelope xmlns:SOAP-ENV="http://schemas.xmlsoap.org/soap/envelope/">
     <SOAP-ENV:Body>
      <SOAP-ENV:Fault xmlns:af="http://www.aras.com/InnovatorFault">
       <faultcode>SOAP-ENV:Server</faultcode>
       <faultstring><![CDATA[An item with the same key has already been added.]]></faultstring>
       <detail>
        <af:legacy_detail><![CDATA[An item with the same key has already been added.]]></af:legacy_detail>
        <af:exception message="An item with the same key has already been added." type="System.ArgumentException" />
       </detail>
      </SOAP-ENV:Fault>
     </SOAP-ENV:Body>
    </SOAP-ENV:Envelope>
    

    Hi Christopher,

    thanks for you reply, I'm trying to complete a custom WF. In details I've customize the ECO WF for a customer and we have put a new activity that start a custom WF. Please find in attach my log file, can you help me to identify the error?

    thanks

    Laura

Reply
  • 2019-05-24-18-45-25-90-19A76F7623774AF09CD2E5D7C8FE27FE.xml
    <LOGFILE>
    <event time="2019-05-24 18:45:25Z" reason="soap_action" TickCount="741734250" dt="32" message="ApplyAML" />
    <event time="2019-05-24 18:45:25Z" reason="requestDom" TickCount="741734250" dt="0" />
    <SOAP-ENV:Envelope xmlns:SOAP-ENV="http://schemas.xmlsoap.org/soap/envelope/">
     <SOAP-ENV:Body>
      <ApplyAML>
       <AML>
        <Item type="Activity" action="EvaluateActivity">
         <Activity>7A9E6AFD8A984E13A6A4ABCC876B6D1A</Activity>
         <ActivityAssignment>45ADB1D4F301497D92AC0A6468245594</ActivityAssignment>
         <Paths>
          <Path id="DE8930F44F0641AF9F8FE8F0F9B6D585"><![CDATA[Complete]]></Path>
         </Paths>
         <DelegateTo>0</DelegateTo>
         <Tasks>
          <Task id="ABA86C2978FD4037AD98D6E03E0381FB" completed="0">
          </Task>
          <Task id="4E5769B0F916432786EDD640674437A2" completed="0">
          </Task>
         </Tasks>
         <Variables>
         </Variables>
         <Authentication mode="">
         </Authentication>
         <Comments>
         </Comments>
         <Complete>1</Complete>
        </Item>
       </AML>
      </ApplyAML>
     </SOAP-ENV:Body>
    </SOAP-ENV:Envelope>
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734421" dt="171" message="GetLCMapFromCache:BD1529204922428C997E86B3BDEA4646:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734421" dt="0" message="Aras.Server.Core.LifeCycleMapInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734437" dt="16" message="GetRelListFromCache:937CE47DE2854308BE6FF5AB1CFB19D4:True:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734437" dt="0" message="Aras.Server.Core.RelTypesList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734468" dt="31" message="GetRelListFromCache:85924010F3184E77B24E9142FDBB481B:True:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734468" dt="0" message="Aras.Server.Core.RelTypesList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734484" dt="16" message="GetRelListFromCache:BD4A250787A742A484C7B174A4AED1E2:True:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734484" dt="0" message="Aras.Server.Core.RelTypesList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734500" dt="16" message="GetRelListFromCache:46BDE53304404C28B5C45610E41C1DD5:True:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734500" dt="0" message="Aras.Server.Core.RelTypesList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734515" dt="15" message="GetRelListFromCache:34682D3EB66141ECACC8796C9D3A42B8:True:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734515" dt="0" message="Aras.Server.Core.RelTypesList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734546" dt="31" message="GetItemTypeIdFromCache:Transition EMail:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734546" dt="0" message="Aras.Server.Core.ItemTypeIdInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734609" dt="63" message="GetRelListFromCache:EB4ADB2BC83C410FB265CB42ED5C633B:True:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734609" dt="0" message="Aras.Server.Core.RelTypesList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734671" dt="62" message="GetServerEventsFromCache:B7DF834246F24F10BC9B91056D828538:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734671" dt="0" message="Aras.Server.Core.MetaDataInfo.ServerEventsList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734671" dt="0" message="GetServerEventsFromCache:CBA93BEFFB4F499CAF122CB79E204983:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734671" dt="0" message="Aras.Server.Core.MetaDataInfo.ServerEventsList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734671" dt="0" message="GetLCSInfoFromCache:FFFF270B50B749D4B9F31DC207BB3996:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734671" dt="0" message="Aras.Server.Core.LifeCycleStateInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734671" dt="0" message="GetLCSInfoFromCache:FB0688A0DD8B4FB2811B4E5F5D128617:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734671" dt="0" message="Aras.Server.Core.LifeCycleStateInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734671" dt="0" message="GetLCSInfoFromCache:AEE8C1553B3A4C50AB67EEDE69CBBA9C:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734671" dt="0" message="Aras.Server.Core.LifeCycleStateInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734671" dt="0" message="GetLCMapFromCache:A84D251567A0468F98159E04EE8CDFA5:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734671" dt="0" message="Aras.Server.Core.LifeCycleMapInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734687" dt="16" message="GetMethodFromCache:E715E11DCD8F49898C2DE499020027FA:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734687" dt="0" message="Aras.Server.Core.CacheMethodInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734703" dt="16" message="GetHistoryTemplateInfoFromCache:3BC16EF9E52B4F9792AB76BCE0492F29:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734703" dt="0" message="Aras.Server.Core.HistoryTemplateInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734703" dt="0" message="GetPropertiesListFromCache:CBA93BEFFB4F499CAF122CB79E204983:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734703" dt="0" message="Aras.Server.Core.PropertiesList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734718" dt="15" message="GetRelListFromCache:CBA93BEFFB4F499CAF122CB79E204983:False:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734718" dt="0" message="Aras.Server.Core.RelTypesList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734765" dt="47" message="GetListFromCache:15B69C0E360D47FD8B482C1144EF7173:id:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734765" dt="0" message="Aras.Server.Core.ListInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734765" dt="0" message="GetMethodIDByNameFromCache:PE_ChangeItemTransition:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734765" dt="0" message="Aras.Server.Core.MethodIdInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734781" dt="16" message="GetItemTypeIdFromCache:Express ECO Affected Item:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734781" dt="0" message="Aras.Server.Core.ItemTypeIdInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734781" dt="0" message="GetServerEventsFromCache:FFE118760ADB44FC984FBE0B633414FC:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734781" dt="0" message="Aras.Server.Core.MetaDataInfo.ServerEventsList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734781" dt="0" message="GetRelListFromCache:FFE118760ADB44FC984FBE0B633414FC:False:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734781" dt="0" message="Aras.Server.Core.RelTypesList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734796" dt="15" message="GetPropertiesListFromCache:FFE118760ADB44FC984FBE0B633414FC:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734796" dt="0" message="Aras.Server.Core.PropertiesList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734796" dt="0" message="AllowedPermissionsList:FFE118760ADB44FC984FBE0B633414FC:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734796" dt="0" message="Aras.Server.Core.PermissionsList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734796" dt="0" message="AllowedPermissionsList:BFAAB0F6838D4F80BF12CB328FF5B097:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734796" dt="0" message="Aras.Server.Core.PermissionsList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734812" dt="16" message="GetPropertiesListFromCache:BFAAB0F6838D4F80BF12CB328FF5B097:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734812" dt="0" message="Aras.Server.Core.PropertiesList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734906" dt="94" message="GetItemTypeIdFromCache:Affected Item:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734906" dt="0" message="Aras.Server.Core.ItemTypeIdInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734906" dt="0" message="GetServerEventsFromCache:BFAAB0F6838D4F80BF12CB328FF5B097:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734906" dt="0" message="Aras.Server.Core.MetaDataInfo.ServerEventsList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734906" dt="0" message="GetRelListFromCache:BFAAB0F6838D4F80BF12CB328FF5B097:False:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734906" dt="0" message="Aras.Server.Core.RelTypesList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734921" dt="15" message="GetPropertiesListFromCache:198BF0BCCC364EE29F56434D803D5F1E:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734921" dt="0" message="Aras.Server.Core.PropertiesList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741734921" dt="0" message="AllowedPermissionsList:198BF0BCCC364EE29F56434D803D5F1E:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741734921" dt="0" message="Aras.Server.Core.PermissionsList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735187" dt="266" message="GetServerEventsFromCache:198BF0BCCC364EE29F56434D803D5F1E:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735187" dt="0" message="Aras.Server.Core.MetaDataInfo.ServerEventsList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735187" dt="0" message="GetServerEventsFromCache:4F1AC04A2B484F3ABA4E20DB63808A88:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735187" dt="0" message="Aras.Server.Core.MetaDataInfo.ServerEventsList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735203" dt="16" message="GetRelListFromCache:4F1AC04A2B484F3ABA4E20DB63808A88:False:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735203" dt="0" message="Aras.Server.Core.RelTypesList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735218" dt="15" message="GetPropertiesListFromCache:4F1AC04A2B484F3ABA4E20DB63808A88:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735218" dt="0" message="Aras.Server.Core.PropertiesList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735218" dt="0" message="AllowedPermissionsList:4F1AC04A2B484F3ABA4E20DB63808A88:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735218" dt="0" message="Aras.Server.Core.PermissionsList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735218" dt="0" message="AllowedPermissionsList:2C6C641717EA48C2AE6548449ABAF79F:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735218" dt="0" message="Aras.Server.Core.PermissionsList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735218" dt="0" message="AllowedPermissionsList:34CAB79C36994D3692D9D8D20BF7894F:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735218" dt="0" message="Aras.Server.Core.PermissionsList" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735250" dt="32" message="GetLCSInfoFromCache:BE7478E822444326A2EC9F1E11A88963:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735250" dt="0" message="Aras.Server.Core.LifeCycleStateInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735250" dt="0" message="GetLCSInfoFromCache:42BB3B183A7748C3B4AA9D33F7BF70AC:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735250" dt="0" message="Aras.Server.Core.LifeCycleStateInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735250" dt="0" message="GetListFromCache:CAE8E3D4280F4804A9DFE5C527C1F42C:id:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735250" dt="0" message="Aras.Server.Core.ListInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735250" dt="0" message="GetListFromCache:E76C49F948B64B918282E2812EFDFAD0:id:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735250" dt="0" message="Aras.Server.Core.ListInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735250" dt="0" message="GetListFromCache:9FEC936F59F14FECAA3621F726FBAAF2:id:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735250" dt="0" message="Aras.Server.Core.ListInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735265" dt="15" message="GetListFromCache:456865E4F30946DE8C7B49D1E011CC25:id:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735265" dt="0" message="Aras.Server.Core.ListInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735265" dt="0" message="GetListFromCache:540DD8228C8043BD905BF401D245926E:id:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735265" dt="0" message="Aras.Server.Core.ListInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735265" dt="0" message="GetListFromCache:F7553D600D57489BB81309E32835AFEC:id:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735265" dt="0" message="Aras.Server.Core.ListInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735265" dt="0" message="GetListFromCache:2BE5CDEBF2114CE88DEF9455ECAF785B:id:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735265" dt="0" message="Aras.Server.Core.ListInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735312" dt="47" message="GetLCSInfoFromCache:72A2322564FE4193933CFB5339487A06:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735312" dt="0" message="Aras.Server.Core.LifeCycleStateInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735312" dt="0" message="GetListFromCache:5C72C69E1762447FAB17F8AD2B3F5DFC:id:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735312" dt="0" message="Aras.Server.Core.ListInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735312" dt="0" message="GetListFromCache:4F0EABD6883348A5BF3CD4C6AAA2873D:id:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735312" dt="0" message="Aras.Server.Core.ListInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735328" dt="16" message="GetListFromCache:50AB0A69063D4AFBA7E4CADFDD444C8A:id:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735328" dt="0" message="Aras.Server.Core.ListInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735328" dt="0" message="GetLCSInfoFromCache:AA93A121BC7346C4907F69820303D2A4:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735328" dt="0" message="Aras.Server.Core.LifeCycleStateInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735328" dt="0" message="GetLCMapFromCache:E337EBF706FA4172B2CD1A6487E00875:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735328" dt="0" message="Aras.Server.Core.LifeCycleMapInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735328" dt="0" message="GetMethodFromCache:D01D8204028D45C38DD33C70F1EFD9C6:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735328" dt="0" message="Aras.Server.Core.CacheMethodInfo" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-key" TickCount="741735328" dt="0" message="GetMethodFromCache:4AD4E5A249AE4492B7FC1D8B548617BB:en" />
    <event time="2019-05-24 18:45:26Z" reason="cachedriver-value" TickCount="741735328" dt="0" message="Aras.Server.Core.CacheMethodInfo" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735640" dt="312" message="GetMethodIDByNameFromCache:FPLCBeforePublish:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735640" dt="0" message="Aras.Server.Core.MethodIdInfo" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735640" dt="0" message="GetItemTypeIdFromCache:Life Cycle Synchronizer:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735640" dt="0" message="Aras.Server.Core.ItemTypeIdInfo" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735640" dt="0" message="GetServerEventsFromCache:2DC7E1B4E74D402B8266AD7559A30AB0:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735640" dt="0" message="Aras.Server.Core.MetaDataInfo.ServerEventsList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735640" dt="0" message="GetRelListFromCache:2DC7E1B4E74D402B8266AD7559A30AB0:False:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735640" dt="0" message="Aras.Server.Core.RelTypesList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735656" dt="16" message="GetPropertiesListFromCache:2DC7E1B4E74D402B8266AD7559A30AB0:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735656" dt="0" message="Aras.Server.Core.PropertiesList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735656" dt="0" message="AllowedPermissionsList:2DC7E1B4E74D402B8266AD7559A30AB0:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735656" dt="0" message="Aras.Server.Core.PermissionsList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735656" dt="0" message="AllowedPermissionsList:AC32527D85604A4D9FC9107C516AEF47:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735656" dt="0" message="Aras.Server.Core.PermissionsList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735671" dt="15" message="GetItemTypeIdFromCache:Life Cycle State Accepted:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735671" dt="0" message="Aras.Server.Core.ItemTypeIdInfo" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735671" dt="0" message="GetServerEventsFromCache:E0E10EC641B4488895640BECADB43DBB:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735671" dt="0" message="Aras.Server.Core.MetaDataInfo.ServerEventsList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735671" dt="0" message="GetRelListFromCache:E0E10EC641B4488895640BECADB43DBB:False:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735671" dt="0" message="Aras.Server.Core.RelTypesList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735671" dt="0" message="GetPropertiesListFromCache:E0E10EC641B4488895640BECADB43DBB:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735671" dt="0" message="Aras.Server.Core.PropertiesList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735671" dt="0" message="AllowedPermissionsList:E0E10EC641B4488895640BECADB43DBB:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735671" dt="0" message="Aras.Server.Core.PermissionsList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735687" dt="16" message="GetItemTypeIdFromCache:Life Cycle State Allow:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735687" dt="0" message="Aras.Server.Core.ItemTypeIdInfo" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735687" dt="0" message="GetServerEventsFromCache:87BD109743F342599992B508154DD2BD:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735687" dt="0" message="Aras.Server.Core.MetaDataInfo.ServerEventsList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735687" dt="0" message="GetRelListFromCache:87BD109743F342599992B508154DD2BD:False:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735687" dt="0" message="Aras.Server.Core.RelTypesList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735703" dt="16" message="GetPropertiesListFromCache:87BD109743F342599992B508154DD2BD:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735703" dt="0" message="Aras.Server.Core.PropertiesList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735703" dt="0" message="AllowedPermissionsList:87BD109743F342599992B508154DD2BD:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735703" dt="0" message="Aras.Server.Core.PermissionsList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735703" dt="0" message="AllowedPermissionsList:C6A89FDE1294451497801DF78341B473:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735703" dt="0" message="Aras.Server.Core.PermissionsList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735750" dt="47" message="GetItemTypeIdFromCache:Life Cycle State Deny:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735750" dt="0" message="Aras.Server.Core.ItemTypeIdInfo" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735750" dt="0" message="GetServerEventsFromCache:C6379FCFFCD449E2933C00E98BC8C929:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735750" dt="0" message="Aras.Server.Core.MetaDataInfo.ServerEventsList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735750" dt="0" message="GetRelListFromCache:C6379FCFFCD449E2933C00E98BC8C929:False:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735750" dt="0" message="Aras.Server.Core.RelTypesList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735765" dt="15" message="GetPropertiesListFromCache:C6379FCFFCD449E2933C00E98BC8C929:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735765" dt="0" message="Aras.Server.Core.PropertiesList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735765" dt="0" message="AllowedPermissionsList:C6379FCFFCD449E2933C00E98BC8C929:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735765" dt="0" message="Aras.Server.Core.PermissionsList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735812" dt="47" message="GetItemTypeIdFromCache:Part CAD:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735812" dt="0" message="Aras.Server.Core.ItemTypeIdInfo" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735812" dt="0" message="GetServerEventsFromCache:935DF68BCFD849EBB5C3A528F04C5B5B:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735812" dt="0" message="Aras.Server.Core.MetaDataInfo.ServerEventsList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735812" dt="0" message="GetRelListFromCache:935DF68BCFD849EBB5C3A528F04C5B5B:False:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735812" dt="0" message="Aras.Server.Core.RelTypesList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735828" dt="16" message="GetPropertiesListFromCache:935DF68BCFD849EBB5C3A528F04C5B5B:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735828" dt="0" message="Aras.Server.Core.PropertiesList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735828" dt="0" message="AllowedPermissionsList:935DF68BCFD849EBB5C3A528F04C5B5B:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735828" dt="0" message="Aras.Server.Core.PermissionsList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735828" dt="0" message="GetServerEventsFromCache:CCF205347C814DD1AF056875E0A880AC:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735828" dt="0" message="Aras.Server.Core.MetaDataInfo.ServerEventsList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735828" dt="0" message="GetRelListFromCache:CCF205347C814DD1AF056875E0A880AC:False:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735828" dt="0" message="Aras.Server.Core.RelTypesList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735843" dt="15" message="GetPropertiesListFromCache:CCF205347C814DD1AF056875E0A880AC:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735843" dt="0" message="Aras.Server.Core.PropertiesList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735859" dt="16" message="GetLCSInfoFromCache:E4F115AAA1FA4D9FB053915171F49007:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735859" dt="0" message="Aras.Server.Core.LifeCycleStateInfo" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735859" dt="0" message="GetListFromCache:11A953CA5A5E4BCD8EC9758C7E4B6E92:id:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735859" dt="0" message="Aras.Server.Core.ListInfo" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735875" dt="16" message="GetServerEventsFromCache:2A5BB1A93BDC436B824B9FFE6DB89553:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735875" dt="0" message="Aras.Server.Core.MetaDataInfo.ServerEventsList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735875" dt="0" message="GetServerEventsFromCache:5E9C5A12CC58413A8670CF4003C57848:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735875" dt="0" message="Aras.Server.Core.MetaDataInfo.ServerEventsList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735875" dt="0" message="GetRelListFromCache:5E9C5A12CC58413A8670CF4003C57848:False:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735875" dt="0" message="Aras.Server.Core.RelTypesList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735890" dt="15" message="GetPropertiesListFromCache:5E9C5A12CC58413A8670CF4003C57848:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735890" dt="0" message="Aras.Server.Core.PropertiesList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735890" dt="0" message="AllowedPermissionsList:5E9C5A12CC58413A8670CF4003C57848:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735890" dt="0" message="Aras.Server.Core.PermissionsList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735890" dt="0" message="GetItemTypeIdFromCache:CAD Structure:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735890" dt="0" message="Aras.Server.Core.ItemTypeIdInfo" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735890" dt="0" message="GetServerEventsFromCache:2812BEB188644E7FB3BEE526FD62032A:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735890" dt="0" message="Aras.Server.Core.MetaDataInfo.ServerEventsList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735890" dt="0" message="GetRelListFromCache:2812BEB188644E7FB3BEE526FD62032A:False:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735890" dt="0" message="Aras.Server.Core.RelTypesList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735906" dt="16" message="GetPropertiesListFromCache:2812BEB188644E7FB3BEE526FD62032A:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735906" dt="0" message="Aras.Server.Core.PropertiesList" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-key" TickCount="741735906" dt="0" message="AllowedPermissionsList:2812BEB188644E7FB3BEE526FD62032A:en" />
    <event time="2019-05-24 18:45:27Z" reason="cachedriver-value" TickCount="741735906" dt="0" message="Aras.Server.Core.PermissionsList" />
    <event time="2019-05-24 18:45:28Z" reason="RollBackAllServerCaches" TickCount="741736375" dt="469" message="99 keys" />
    <event time="2019-05-24 18:45:28Z" reason="performance" TickCount="741736375" dt="0" message="2157" />
    <event time="2019-05-24 18:45:28Z" reason="responseDom" TickCount="741736375" dt="0" />
    <SOAP-ENV:Envelope xmlns:SOAP-ENV="http://schemas.xmlsoap.org/soap/envelope/">
     <SOAP-ENV:Body>
      <SOAP-ENV:Fault xmlns:af="http://www.aras.com/InnovatorFault">
       <faultcode>SOAP-ENV:Server</faultcode>
       <faultstring><![CDATA[An item with the same key has already been added.]]></faultstring>
       <detail>
        <af:legacy_detail><![CDATA[An item with the same key has already been added.]]></af:legacy_detail>
        <af:exception message="An item with the same key has already been added." type="System.ArgumentException" />
       </detail>
      </SOAP-ENV:Fault>
     </SOAP-ENV:Body>
    </SOAP-ENV:Envelope>
    

    Hi Christopher,

    thanks for you reply, I'm trying to complete a custom WF. In details I've customize the ECO WF for a customer and we have put a new activity that start a custom WF. Please find in attach my log file, can you help me to identify the error?

    thanks

    Laura

Children