|
1
|
2020-01-03 18:32:20,345+01 [SCIO Watcher 0] INFO o.o.i.s.wrapper.SingleThreadChannel:139 - Card connected with protocol T=1.
|
|
2
|
2020-01-03 18:32:20,345+01 [IFD Watcher 0] DEBUG o.o.common.util.HandlerUtils:132 - Found ContextHandle in object of type GetIFDCapabilities.
|
|
3
|
2020-01-03 18:32:20,356+01 [IFD Watcher 0] DEBUG o.o.t.dispatcher.MessageDispatcher:105 - Sending API_CALL_STARTED event.
|
|
4
|
2020-01-03 18:32:20,356+01 [IFD Watcher 0] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_STARTED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
5
|
2020-01-03 18:32:20,356+01 [IFD Watcher 0] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_STARTED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
6
|
2020-01-03 18:32:20,356+01 [IFD Watcher 0] DEBUG o.o.t.dispatcher.MessageDispatcher:114 - Delivering message of type: iso.std.iso_iec._24727.tech.schema.GetIFDCapabilities
|
|
7
|
2020-01-03 18:32:20,356+01 [IFD Watcher 0] WARN o.o.ifd.scio.wrapper.ChannelManager:87 - Terminal 'Microsoft IFD 0' is already connected.
|
|
8
|
2020-01-03 18:32:20,365+01 [IFD Watcher 0] WARN o.o.ifd.scio.wrapper.TerminalInfo:323 - Unable to request features from reader.
|
|
9
|
org.openecard.common.ifd.scio.SCIOException: Failed to transmit control command to the terminal 'Microsoft IFD 0'.
|
|
10
|
at org.openecard.scio.PCSCCard.transmitControlCommand(PCSCCard.java:110)
|
|
11
|
at org.openecard.ifd.scio.wrapper.SingleThreadChannel.lambda$transmitControlCommand$2(SingleThreadChannel.java:288)
|
|
12
|
at java.util.concurrent.FutureTask.run(Unknown Source)
|
|
13
|
at java.util.concurrent.ThreadPoolExecutor.runWorker(Unknown Source)
|
|
14
|
at java.util.concurrent.ThreadPoolExecutor$Worker.run(Unknown Source)
|
|
15
|
at java.lang.Thread.run(Unknown Source)
|
|
16
|
Caused by: javax.smartcardio.CardException: transmitControlCommand() failed
|
|
17
|
at sun.security.smartcardio.CardImpl.transmitControlCommand(Unknown Source)
|
|
18
|
at org.openecard.scio.PCSCCard.transmitControlCommand(PCSCCard.java:107)
|
|
19
|
... 5 common frames omitted
|
|
20
|
Caused by: sun.security.smartcardio.PCSCException: Unknown error 0x32
|
|
21
|
at sun.security.smartcardio.PCSC.SCardControl(Native Method)
|
|
22
|
... 7 common frames omitted
|
|
23
|
2020-01-03 18:32:20,376+01 [IFD Watcher 0] DEBUG o.o.t.dispatcher.MessageDispatcher:122 - Sending API_CALL_FINISHED event.
|
|
24
|
2020-01-03 18:32:20,376+01 [IFD Watcher 0] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_FINISHED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
25
|
2020-01-03 18:32:20,376+01 [IFD Watcher 0] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_FINISHED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
26
|
2020-01-03 18:32:20,376+01 [IFD Watcher 0] DEBUG o.o.ifd.event.IfdEventRunner:235 - Found a card insert event (Microsoft IFD 0).
|
|
27
|
2020-01-03 18:32:20,376+01 [IFD Watcher 0] INFO o.o.ifd.event.IfdEventRunner:236 - Card with ATR=3B8780018031B8738401E019 inserted.
|
|
28
|
2020-01-03 18:32:20,376+01 [IFD Watcher 0] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification CARD_INSERTED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
29
|
2020-01-03 18:32:20,376+01 [IFD Watcher 0] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification CARD_INSERTED to EventCallback org.openecard.richclient.gui.Status@7d8704ef.
|
|
30
|
2020-01-03 18:32:20,376+01 [IFD Watcher 0] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification CARD_INSERTED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
31
|
2020-01-03 18:32:20,376+01 [Dispatcher Event 1] DEBUG org.openecard.richclient.gui.Status:378 - Event: CARD_INSERTED
|
|
32
|
2020-01-03 18:32:20,376+01 [IFD Watcher 0] WARN o.o.ifd.scio.wrapper.ChannelManager:87 - Terminal 'Microsoft IFD 0' is already connected.
|
|
33
|
2020-01-03 18:32:20,376+01 [Dispatcher Event 1] DEBUG org.openecard.richclient.gui.Status:388 - ConnectionHandle: ifd=Microsoft IFD 0, slot=null, ctx=E732319C56E5299A2B55A6BC9A10F83A
|
|
34
|
2020-01-03 18:32:20,376+01 [Dispatcher Event 1] DEBUG org.openecard.richclient.gui.Status:392 - RecognitionInfo: http://bsi.bund.de/cif/unknown, 3B8780018031B8738401E019
|
|
35
|
2020-01-03 18:32:20,376+01 [Dispatcher Event 1] DEBUG org.openecard.richclient.gui.Status:420 - Event sent has responsibility=true for this card.
|
|
36
|
2020-01-03 18:32:20,376+01 [IFD Watcher 1] DEBUG o.o.common.util.HandlerUtils:132 - Found ContextHandle in object of type Connect.
|
|
37
|
2020-01-03 18:32:20,385+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:105 - Sending API_CALL_STARTED event.
|
|
38
|
2020-01-03 18:32:20,385+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_STARTED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
39
|
2020-01-03 18:32:20,385+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_STARTED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
40
|
2020-01-03 18:32:20,390+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:114 - Delivering message of type: iso.std.iso_iec._24727.tech.schema.Connect
|
|
41
|
2020-01-03 18:32:20,390+01 [IFD Watcher 1] WARN o.o.ifd.scio.wrapper.ChannelManager:87 - Terminal 'Microsoft IFD 0' is already connected.
|
|
42
|
2020-01-03 18:32:20,395+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:122 - Sending API_CALL_FINISHED event.
|
|
43
|
2020-01-03 18:32:20,395+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_FINISHED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
44
|
2020-01-03 18:32:20,395+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_FINISHED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
45
|
2020-01-03 18:32:20,395+01 [IFD Watcher 1] DEBUG o.o.common.util.HandlerUtils:145 - Found SlotHandle in object of type BeginTransaction.
|
|
46
|
2020-01-03 18:32:20,406+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:105 - Sending API_CALL_STARTED event.
|
|
47
|
2020-01-03 18:32:20,406+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_STARTED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
48
|
2020-01-03 18:32:20,406+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_STARTED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
49
|
2020-01-03 18:32:20,406+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:114 - Delivering message of type: iso.std.iso_iec._24727.tech.schema.BeginTransaction
|
|
50
|
2020-01-03 18:32:20,415+01 [IFD Watcher 0] DEBUG o.o.scio.PCSCTerminals$PCSCWatcher:201 - Detecting initial terminal status.
|
|
51
|
2020-01-03 18:32:20,415+01 [IFD Watcher 0] DEBUG o.o.scio.PCSCTerminals$PCSCWatcher:205 - Terminal='Microsoft IFD 0' cardPresent=true
|
|
52
|
2020-01-03 18:32:20,425+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:122 - Sending API_CALL_FINISHED event.
|
|
53
|
2020-01-03 18:32:20,425+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_FINISHED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
54
|
2020-01-03 18:32:20,425+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_FINISHED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
55
|
2020-01-03 18:32:20,425+01 [IFD Watcher 1] DEBUG o.o.common.util.HandlerUtils:145 - Found SlotHandle in object of type Transmit.
|
|
56
|
2020-01-03 18:32:20,430+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:105 - Sending API_CALL_STARTED event.
|
|
57
|
2020-01-03 18:32:20,430+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_STARTED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
58
|
2020-01-03 18:32:20,430+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_STARTED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
59
|
2020-01-03 18:32:20,430+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:114 - Delivering message of type: iso.std.iso_iec._24727.tech.schema.Transmit
|
|
60
|
2020-01-03 18:32:20,430+01 [IFD Watcher 1] DEBUG o.o.i.s.wrapper.SingleThreadChannel:251 - Send APDU: 00A4000C023F00
|
|
61
|
2020-01-03 18:32:20,441+01 [IFD Watcher 1] DEBUG o.o.i.s.wrapper.SingleThreadChannel:254 - Receive APDU: 9000
|
|
62
|
2020-01-03 18:32:20,446+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:122 - Sending API_CALL_FINISHED event.
|
|
63
|
2020-01-03 18:32:20,446+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_FINISHED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
64
|
2020-01-03 18:32:20,446+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_FINISHED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
65
|
2020-01-03 18:32:20,446+01 [IFD Watcher 1] DEBUG o.o.common.util.HandlerUtils:145 - Found SlotHandle in object of type Transmit.
|
|
66
|
2020-01-03 18:32:20,446+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:105 - Sending API_CALL_STARTED event.
|
|
67
|
2020-01-03 18:32:20,446+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_STARTED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
68
|
2020-01-03 18:32:20,446+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_STARTED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
69
|
2020-01-03 18:32:20,446+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:114 - Delivering message of type: iso.std.iso_iec._24727.tech.schema.Transmit
|
|
70
|
2020-01-03 18:32:20,456+01 [IFD Watcher 1] DEBUG o.o.i.s.wrapper.SingleThreadChannel:251 - Send APDU: 00A4020C020003
|
|
71
|
2020-01-03 18:32:20,461+01 [IFD Watcher 1] DEBUG o.o.i.s.wrapper.SingleThreadChannel:254 - Receive APDU: 6A82
|
|
72
|
2020-01-03 18:32:20,466+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:122 - Sending API_CALL_FINISHED event.
|
|
73
|
2020-01-03 18:32:20,466+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_FINISHED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
74
|
2020-01-03 18:32:20,466+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_FINISHED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
75
|
2020-01-03 18:32:20,466+01 [IFD Watcher 1] DEBUG o.o.common.util.HandlerUtils:145 - Found SlotHandle in object of type Transmit.
|
|
76
|
2020-01-03 18:32:20,476+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:105 - Sending API_CALL_STARTED event.
|
|
77
|
2020-01-03 18:32:20,476+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_STARTED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
78
|
2020-01-03 18:32:20,476+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_STARTED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
79
|
2020-01-03 18:32:20,476+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:114 - Delivering message of type: iso.std.iso_iec._24727.tech.schema.Transmit
|
|
80
|
2020-01-03 18:32:20,476+01 [IFD Watcher 1] DEBUG o.o.i.s.wrapper.SingleThreadChannel:251 - Send APDU: 00A4000C023F00
|
|
81
|
2020-01-03 18:32:20,476+01 [IFD Watcher 1] DEBUG o.o.i.s.wrapper.SingleThreadChannel:254 - Receive APDU: 9000
|
|
82
|
2020-01-03 18:32:20,486+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:122 - Sending API_CALL_FINISHED event.
|
|
83
|
2020-01-03 18:32:20,486+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_FINISHED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
84
|
2020-01-03 18:32:20,486+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_FINISHED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
85
|
2020-01-03 18:32:20,486+01 [IFD Watcher 1] DEBUG o.o.common.util.HandlerUtils:145 - Found SlotHandle in object of type Transmit.
|
|
86
|
2020-01-03 18:32:20,486+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:105 - Sending API_CALL_STARTED event.
|
|
87
|
2020-01-03 18:32:20,486+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_STARTED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
88
|
2020-01-03 18:32:20,486+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_STARTED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
89
|
2020-01-03 18:32:20,486+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:114 - Delivering message of type: iso.std.iso_iec._24727.tech.schema.Transmit
|
|
90
|
2020-01-03 18:32:20,486+01 [IFD Watcher 1] DEBUG o.o.i.s.wrapper.SingleThreadChannel:251 - Send APDU: 00A4020C022F00
|
|
91
|
2020-01-03 18:32:20,501+01 [IFD Watcher 1] DEBUG o.o.i.s.wrapper.SingleThreadChannel:254 - Receive APDU: 9000
|
|
92
|
2020-01-03 18:32:20,506+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:122 - Sending API_CALL_FINISHED event.
|
|
93
|
2020-01-03 18:32:20,506+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_FINISHED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
94
|
2020-01-03 18:32:20,506+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_FINISHED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
95
|
2020-01-03 18:32:20,506+01 [IFD Watcher 1] DEBUG o.o.common.util.HandlerUtils:145 - Found SlotHandle in object of type Transmit.
|
|
96
|
2020-01-03 18:32:20,506+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:105 - Sending API_CALL_STARTED event.
|
|
97
|
2020-01-03 18:32:20,506+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_STARTED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
98
|
2020-01-03 18:32:20,506+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_STARTED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
99
|
2020-01-03 18:32:20,506+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:114 - Delivering message of type: iso.std.iso_iec._24727.tech.schema.Transmit
|
|
100
|
2020-01-03 18:32:20,506+01 [IFD Watcher 1] DEBUG o.o.i.s.wrapper.SingleThreadChannel:251 - Send APDU: 00B20404FF
|
|
101
|
2020-01-03 18:32:20,516+01 [IFD Watcher 1] DEBUG o.o.i.s.wrapper.SingleThreadChannel:254 - Receive APDU: 6D00
|
|
102
|
2020-01-03 18:32:20,516+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:122 - Sending API_CALL_FINISHED event.
|
|
103
|
2020-01-03 18:32:20,516+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_FINISHED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
104
|
2020-01-03 18:32:20,516+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_FINISHED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
105
|
2020-01-03 18:32:20,516+01 [IFD Watcher 1] DEBUG o.o.common.util.HandlerUtils:145 - Found SlotHandle in object of type Transmit.
|
|
106
|
2020-01-03 18:32:20,526+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:105 - Sending API_CALL_STARTED event.
|
|
107
|
2020-01-03 18:32:20,526+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_STARTED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
108
|
2020-01-03 18:32:20,526+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_STARTED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
109
|
2020-01-03 18:32:20,526+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:114 - Delivering message of type: iso.std.iso_iec._24727.tech.schema.Transmit
|
|
110
|
2020-01-03 18:32:20,526+01 [IFD Watcher 1] DEBUG o.o.i.s.wrapper.SingleThreadChannel:251 - Send APDU: 00A4000C023F00
|
|
111
|
2020-01-03 18:32:20,533+01 [IFD Watcher 1] DEBUG o.o.i.s.wrapper.SingleThreadChannel:254 - Receive APDU: 9000
|
|
112
|
2020-01-03 18:32:20,536+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:122 - Sending API_CALL_FINISHED event.
|
|
113
|
2020-01-03 18:32:20,536+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_FINISHED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
114
|
2020-01-03 18:32:20,536+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_FINISHED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
115
|
2020-01-03 18:32:20,536+01 [IFD Watcher 1] DEBUG o.o.common.util.HandlerUtils:145 - Found SlotHandle in object of type Transmit.
|
|
116
|
2020-01-03 18:32:20,541+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:105 - Sending API_CALL_STARTED event.
|
|
117
|
2020-01-03 18:32:20,541+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_STARTED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
118
|
2020-01-03 18:32:20,541+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_STARTED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
119
|
2020-01-03 18:32:20,541+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:114 - Delivering message of type: iso.std.iso_iec._24727.tech.schema.Transmit
|
|
120
|
2020-01-03 18:32:20,541+01 [IFD Watcher 1] DEBUG o.o.i.s.wrapper.SingleThreadChannel:251 - Send APDU: 00A4020C022F00
|
|
121
|
2020-01-03 18:32:20,546+01 [IFD Watcher 1] DEBUG o.o.i.s.wrapper.SingleThreadChannel:254 - Receive APDU: 9000
|
|
122
|
2020-01-03 18:32:20,556+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:122 - Sending API_CALL_FINISHED event.
|
|
123
|
2020-01-03 18:32:20,556+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_FINISHED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
124
|
2020-01-03 18:32:20,556+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_FINISHED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
125
|
2020-01-03 18:32:20,556+01 [IFD Watcher 1] DEBUG o.o.common.util.HandlerUtils:145 - Found SlotHandle in object of type Transmit.
|
|
126
|
2020-01-03 18:32:20,556+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:105 - Sending API_CALL_STARTED event.
|
|
127
|
2020-01-03 18:32:20,556+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_STARTED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
128
|
2020-01-03 18:32:20,556+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_STARTED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
129
|
2020-01-03 18:32:20,556+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:114 - Delivering message of type: iso.std.iso_iec._24727.tech.schema.Transmit
|
|
130
|
2020-01-03 18:32:20,556+01 [IFD Watcher 1] DEBUG o.o.i.s.wrapper.SingleThreadChannel:251 - Send APDU: 00B20304FF
|
|
131
|
2020-01-03 18:32:20,566+01 [IFD Watcher 1] DEBUG o.o.i.s.wrapper.SingleThreadChannel:254 - Receive APDU: 6D00
|
|
132
|
2020-01-03 18:32:20,576+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:122 - Sending API_CALL_FINISHED event.
|
|
133
|
2020-01-03 18:32:20,576+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_FINISHED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
134
|
2020-01-03 18:32:20,576+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_FINISHED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
135
|
2020-01-03 18:32:20,576+01 [IFD Watcher 1] DEBUG o.o.common.util.HandlerUtils:145 - Found SlotHandle in object of type Transmit.
|
|
136
|
2020-01-03 18:32:20,576+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:105 - Sending API_CALL_STARTED event.
|
|
137
|
2020-01-03 18:32:20,576+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_STARTED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
138
|
2020-01-03 18:32:20,576+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_STARTED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
139
|
2020-01-03 18:32:20,576+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:114 - Delivering message of type: iso.std.iso_iec._24727.tech.schema.Transmit
|
|
140
|
2020-01-03 18:32:20,576+01 [IFD Watcher 1] DEBUG o.o.i.s.wrapper.SingleThreadChannel:251 - Send APDU: 00A4040C0FF04573744549442076657220312E30
|
|
141
|
2020-01-03 18:32:20,590+01 [IFD Watcher 1] DEBUG o.o.i.s.wrapper.SingleThreadChannel:254 - Receive APDU: 6A82
|
|
142
|
2020-01-03 18:32:20,595+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:122 - Sending API_CALL_FINISHED event.
|
|
143
|
2020-01-03 18:32:20,595+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_FINISHED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
144
|
2020-01-03 18:32:20,595+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_FINISHED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
145
|
2020-01-03 18:32:20,595+01 [IFD Watcher 1] DEBUG o.o.common.util.HandlerUtils:145 - Found SlotHandle in object of type Transmit.
|
|
146
|
2020-01-03 18:32:20,595+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:105 - Sending API_CALL_STARTED event.
|
|
147
|
2020-01-03 18:32:20,595+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_STARTED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
148
|
2020-01-03 18:32:20,595+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_STARTED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
149
|
2020-01-03 18:32:20,595+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:114 - Delivering message of type: iso.std.iso_iec._24727.tech.schema.Transmit
|
|
150
|
2020-01-03 18:32:20,595+01 [IFD Watcher 1] DEBUG o.o.i.s.wrapper.SingleThreadChannel:251 - Send APDU: 00A4040C0FD23300000045737445494420763335
|
|
151
|
2020-01-03 18:32:20,610+01 [IFD Watcher 1] DEBUG o.o.i.s.wrapper.SingleThreadChannel:254 - Receive APDU: 6A82
|
|
152
|
2020-01-03 18:32:20,615+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:122 - Sending API_CALL_FINISHED event.
|
|
153
|
2020-01-03 18:32:20,615+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_FINISHED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
154
|
2020-01-03 18:32:20,615+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_FINISHED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
155
|
2020-01-03 18:32:20,615+01 [IFD Watcher 1] DEBUG o.o.common.util.HandlerUtils:145 - Found SlotHandle in object of type Transmit.
|
|
156
|
2020-01-03 18:32:20,615+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:105 - Sending API_CALL_STARTED event.
|
|
157
|
2020-01-03 18:32:20,615+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_STARTED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
158
|
2020-01-03 18:32:20,615+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_STARTED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
159
|
2020-01-03 18:32:20,615+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:114 - Delivering message of type: iso.std.iso_iec._24727.tech.schema.Transmit
|
|
160
|
2020-01-03 18:32:20,615+01 [IFD Watcher 1] DEBUG o.o.i.s.wrapper.SingleThreadChannel:251 - Send APDU: 00A4000C023F00
|
|
161
|
2020-01-03 18:32:20,625+01 [IFD Watcher 1] DEBUG o.o.i.s.wrapper.SingleThreadChannel:254 - Receive APDU: 9000
|
|
162
|
2020-01-03 18:32:20,636+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:122 - Sending API_CALL_FINISHED event.
|
|
163
|
2020-01-03 18:32:20,636+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_FINISHED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
164
|
2020-01-03 18:32:20,636+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_FINISHED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
165
|
2020-01-03 18:32:20,636+01 [IFD Watcher 1] DEBUG o.o.common.util.HandlerUtils:145 - Found SlotHandle in object of type Transmit.
|
|
166
|
2020-01-03 18:32:20,636+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:105 - Sending API_CALL_STARTED event.
|
|
167
|
2020-01-03 18:32:20,636+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_STARTED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
168
|
2020-01-03 18:32:20,636+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_STARTED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
169
|
2020-01-03 18:32:20,636+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:114 - Delivering message of type: iso.std.iso_iec._24727.tech.schema.Transmit
|
|
170
|
2020-01-03 18:32:20,636+01 [IFD Watcher 1] DEBUG o.o.i.s.wrapper.SingleThreadChannel:251 - Send APDU: 00A4020C022F00
|
|
171
|
2020-01-03 18:32:20,646+01 [IFD Watcher 1] DEBUG o.o.i.s.wrapper.SingleThreadChannel:254 - Receive APDU: 9000
|
|
172
|
2020-01-03 18:32:20,651+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:122 - Sending API_CALL_FINISHED event.
|
|
173
|
2020-01-03 18:32:20,651+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_FINISHED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
174
|
2020-01-03 18:32:20,651+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_FINISHED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
175
|
2020-01-03 18:32:20,651+01 [IFD Watcher 1] DEBUG o.o.common.util.HandlerUtils:145 - Found SlotHandle in object of type Transmit.
|
|
176
|
2020-01-03 18:32:20,656+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:105 - Sending API_CALL_STARTED event.
|
|
177
|
2020-01-03 18:32:20,656+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_STARTED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
178
|
2020-01-03 18:32:20,656+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_STARTED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
179
|
2020-01-03 18:32:20,656+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:114 - Delivering message of type: iso.std.iso_iec._24727.tech.schema.Transmit
|
|
180
|
2020-01-03 18:32:20,656+01 [IFD Watcher 1] DEBUG o.o.i.s.wrapper.SingleThreadChannel:251 - Send APDU: 00B00000FF
|
|
181
|
2020-01-03 18:32:20,676+01 [IFD Watcher 1] DEBUG o.o.i.s.wrapper.SingleThreadChannel:254 - Receive APDU: 61324F0FE828BD080FA000000167455349474E500F434941207A752044462E655369676E5100730C4F0AA000000167455349474E61094F07A0000002471001610B4F09E80704007F00070302610C4F0AA000000167455349474E6282
|
|
182
|
2020-01-03 18:32:20,681+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:122 - Sending API_CALL_FINISHED event.
|
|
183
|
2020-01-03 18:32:20,681+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_FINISHED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
184
|
2020-01-03 18:32:20,686+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_FINISHED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
185
|
2020-01-03 18:32:20,686+01 [IFD Watcher 1] DEBUG o.o.common.util.HandlerUtils:145 - Found SlotHandle in object of type EndTransaction.
|
|
186
|
2020-01-03 18:32:20,686+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:105 - Sending API_CALL_STARTED event.
|
|
187
|
2020-01-03 18:32:20,686+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_STARTED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
188
|
2020-01-03 18:32:20,686+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_STARTED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
189
|
2020-01-03 18:32:20,686+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:114 - Delivering message of type: iso.std.iso_iec._24727.tech.schema.EndTransaction
|
|
190
|
2020-01-03 18:32:20,686+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:122 - Sending API_CALL_FINISHED event.
|
|
191
|
2020-01-03 18:32:20,686+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_FINISHED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
192
|
2020-01-03 18:32:20,686+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_FINISHED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
193
|
2020-01-03 18:32:20,696+01 [IFD Watcher 1] DEBUG o.o.common.util.HandlerUtils:145 - Found SlotHandle in object of type Disconnect.
|
|
194
|
2020-01-03 18:32:20,696+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:105 - Sending API_CALL_STARTED event.
|
|
195
|
2020-01-03 18:32:20,696+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_STARTED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
196
|
2020-01-03 18:32:20,696+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_STARTED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
197
|
2020-01-03 18:32:20,696+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:114 - Delivering message of type: iso.std.iso_iec._24727.tech.schema.Disconnect
|
|
198
|
2020-01-03 18:32:20,706+01 [IFD Watcher 1] DEBUG o.o.t.dispatcher.MessageDispatcher:122 - Sending API_CALL_FINISHED event.
|
|
199
|
2020-01-03 18:32:20,706+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_FINISHED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
200
|
2020-01-03 18:32:20,706+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification API_CALL_FINISHED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
201
|
2020-01-03 18:32:20,706+01 [IFD Watcher 1] DEBUG org.openecard.ifd.event.Recognizer:60 - Found a recognized card event (Microsoft IFD 0).
|
|
202
|
2020-01-03 18:32:20,706+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification CARD_RECOGNIZED to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
203
|
2020-01-03 18:32:20,706+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification CARD_RECOGNIZED to EventCallback org.openecard.richclient.gui.Status@7d8704ef.
|
|
204
|
2020-01-03 18:32:20,706+01 [Dispatcher Event 1] DEBUG org.openecard.richclient.gui.Status:378 - Event: CARD_RECOGNIZED
|
|
205
|
2020-01-03 18:32:20,706+01 [IFD Watcher 1] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification CARD_RECOGNIZED to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
206
|
2020-01-03 18:32:20,706+01 [Dispatcher Event 1] DEBUG org.openecard.richclient.gui.Status:388 - ConnectionHandle: ifd=Microsoft IFD 0, slot=null, ctx=E732319C56E5299A2B55A6BC9A10F83A
|
|
207
|
2020-01-03 18:32:20,706+01 [Dispatcher Event 1] DEBUG org.openecard.richclient.gui.Status:392 - RecognitionInfo: http://bsi.bund.de/cif/npa.xml, null
|
|
208
|
2020-01-03 18:32:20,706+01 [Dispatcher Event 1] DEBUG org.openecard.richclient.gui.Status:420 - Event sent has responsibility=true for this card.
|
|
209
|
2020-01-03 18:32:20,706+01 [Dispatcher Event 2] INFO o.o.c.sal.state.SALStateCallback:63 - Add ConnectionHandle to SAL:
|
|
210
|
ConnectionHandle:
|
|
211
|
Session: 4ET2RopGSFj6mp1-v4Gqwg
|
|
212
|
ContextHandle: E732319C56E5299A2B55A6BC9A10F83A
|
|
213
|
IFDName: Microsoft IFD 0 SlotIndex: 0
|
|
214
|
CardType: http://bsi.bund.de/cif/npa.xml
|
|
215
|
2020-01-03 18:32:20,706+01 [Dispatcher Event 2] DEBUG org.openecard.sal.SelectorSAL:185 - Looking up responsible SAL for handle with, ctx=E732319C56E5299A2B55A6BC9A10F83A, slot=null
|
|
216
|
2020-01-03 18:32:20,706+01 [Dispatcher Event 2] DEBUG org.openecard.sal.SelectorSAL:193 - Requesting CIF from CIF-Repo for type=http://bsi.bund.de/cif/npa.xml.
|
|
217
|
2020-01-03 18:32:20,706+01 [Dispatcher Event 2] DEBUG o.o.r.staticrepo.LocalCifRepo:131 - Requesting CIFs with GetCardInfoOrACD call.
|
|
218
|
2020-01-03 18:32:20,745+01 [Dispatcher Event 1] DEBUG org.openecard.sal.SelectorSAL:205 - Requesting CIF from CIF-Repo for type=http://bsi.bund.de/cif/npa.xml.
|
|
219
|
2020-01-03 18:32:20,745+01 [Dispatcher Event 1] DEBUG o.o.r.staticrepo.LocalCifRepo:131 - Requesting CIFs with GetCardInfoOrACD call.
|
|
220
|
2020-01-03 18:32:20,776+01 [Dispatcher Event 2] DEBUG o.o.r.staticrepo.LocalCifRepo:172 - Returning CIFs from GetCardInfoOrACD call.
|
|
221
|
2020-01-03 18:32:20,776+01 [Dispatcher Event 2] DEBUG o.o.common.sal.state.CardStateMap:94 - Add new entry to card states: CardStateEntry@0 {
|
|
222
|
handle= ConnectionHandle {
|
|
223
|
ctx=E732319C56E5299A2B55A6BC9A10F83A
|
|
224
|
ifd=Microsoft IFD 0
|
|
225
|
idx=0
|
|
226
|
slot=null
|
|
227
|
app=3F00
|
|
228
|
Recognition {
|
|
229
|
typ=http://bsi.bund.de/cif/npa.xml
|
|
230
|
ident=null
|
|
231
|
}
|
|
232
|
}
|
|
233
|
}
|
|
234
|
2020-01-03 18:32:20,776+01 [Dispatcher Event 2] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification RECOGNIZED_CARD_ACTIVE to EventCallback org.openecard.addon.EventHandler@6b1274d2.
|
|
235
|
2020-01-03 18:32:20,776+01 [Dispatcher Event 2] DEBUG o.o.c.event.EventDispatcherImpl:140 - Sending event notification RECOGNIZED_CARD_ACTIVE to EventCallback org.openecard.common.sal.state.SALStateCallback@51b279c9.
|
|
236
|
2020-01-03 18:32:20,821+01 [Dispatcher Event 1] DEBUG o.o.r.staticrepo.LocalCifRepo:172 - Returning CIFs from GetCardInfoOrACD call.
|
|
237
|
2020-01-03 18:32:31,253+01 [Thread-9] DEBUG o.o.c.b.h.h.HttpAppPluginActionHandler:88 - HTTP request: GET /eID-Client?tcTokenURL=https%3A%2F%2Fwww.eservice-drv.de%2FOnlineDiensteWeb%2FRedirect%3Fref%3D7F263B8753F0A56F2E3757426946EC724492B2E29C94CC6CFA4ACA246F126AE9E3F630C3DFAFDFFD [Host: 127.0.0.1:24727, User-Agent: Mozilla/5.0 (Windows NT 10.0; Win64; x64; rv:71.0) Gecko/20100101 Firefox/71.0, Accept: text/html,application/xhtml+xml,application/xml;q=0.9,*/*;q=0.8, Accept-Language: de,en-US;q=0.7,en;q=0.3, Accept-Encoding: gzip, deflate, DNT: 1, Connection: keep-alive, Upgrade-Insecure-Requests: 1]
|
|
238
|
2020-01-03 18:32:31,253+01 [Thread-9] WARN org.openecard.common.I18n:152 - Failed to load resource tr03112 for lang de_DE.
|
|
239
|
2020-01-03 18:32:31,268+01 [Thread-9] WARN org.openecard.common.I18n:152 - Failed to load resource tctoken for lang de_DE.
|
|
240
|
2020-01-03 18:32:31,268+01 [Thread-9] WARN org.openecard.common.I18n:152 - Failed to load resource pinplugin for lang de_DE.
|
|
241
|
2020-01-03 18:32:31,268+01 [Thread-9] WARN org.openecard.common.I18n:152 - Failed to load resource pace for lang de_DE.
|
|
242
|
2020-01-03 18:32:31,268+01 [FuturePromise-3] WARN o.o.common.util.JAXPSchemaValidator:143 - Did not find a default SchemaFactory.
|
|
243
|
2020-01-03 18:32:31,284+01 [Thread-9] DEBUG org.openecard.sal.SelectorSAL:205 - Requesting CIF from CIF-Repo for type=http://bsi.bund.de/cif/npa.xml.
|
|
244
|
2020-01-03 18:32:31,284+01 [Thread-9] DEBUG o.o.r.staticrepo.LocalCifRepo:131 - Requesting CIFs with GetCardInfoOrACD call.
|
|
245
|
2020-01-03 18:32:31,346+01 [Thread-9] DEBUG o.o.r.staticrepo.LocalCifRepo:172 - Returning CIFs from GetCardInfoOrACD call.
|
|
246
|
2020-01-03 18:32:31,346+01 [Thread-9] INFO o.o.binding.tctoken.ResourceContext:207 - Trying to load resource from: https://www.eservice-drv.de/OnlineDiensteWeb/Redirect?ref=7F263B8753F0A56F2E3757426946EC724492B2E29C94CC6CFA4ACA246F126AE9E3F630C3DFAFDFFD
|
|
247
|
2020-01-03 18:32:31,424+01 [Thread-9] DEBUG o.o.crypto.tls.proxy.ProxySettings:133 - Selecting proxy: DIRECT
|
|
248
|
2020-01-03 18:32:31,424+01 [Thread-9] DEBUG o.o.crypto.tls.proxy.ProxySettings:168 - Using proxy (DIRECT) to obtain socket.
|
|
249
|
2020-01-03 18:32:31,471+01 [Thread-9] DEBUG o.o.binding.tctoken.ResourceContext:244 - Performing TLS handshake.
|
|
250
|
2020-01-03 18:32:31,581+01 [Thread-9] DEBUG o.o.c.tls.verify.HostnameVerifier:126 - Comparing connection hostname against certificate hostname: [www.eservice-drv.de] [www.eservice-drv.de]
|
|
251
|
2020-01-03 18:32:31,784+01 [Thread-9] DEBUG o.o.binding.tctoken.ResourceContext:246 - TLS handshake performed.
|
|
252
|
2020-01-03 18:32:31,799+01 [Thread-9] DEBUG o.o.transport.httpcore.HttpUtils:81 - HTTP Request:
|
|
253
|
GET /OnlineDiensteWeb/Redirect?ref=7F263B8753F0A56F2E3757426946EC724492B2E29C94CC6CFA4ACA246F126AE9E3F630C3DFAFDFFD HTTP/1.1
|
|
254
|
Connection: keep-alive
|
|
255
|
User-Agent: Open eCard App/1.3.0
|
|
256
|
Host: www.eservice-drv.de
|
|
257
|
Accept: text/xml, */*;q=0.8
|
|
258
|
Accept-Charset: utf-8, *;q=0.8
|
|
259
|
|
|
260
|
2020-01-03 18:32:31,799+01 [Thread-9] DEBUG o.o.binding.tctoken.ResourceContext:267 - Sending HTTP request.
|
|
261
|
2020-01-03 18:32:31,846+01 [Thread-9] DEBUG o.o.t.h.cookies.CookieManager:130 - Setting cookie JSESSIONID=0000rhtqiMzSc-J6vvLZWMIRTGM+17emeff5r for domain www.eservice-drv.de.
|
|
262
|
2020-01-03 18:32:31,846+01 [Thread-9] DEBUG o.o.binding.tctoken.ResourceContext:270 - HTTP response received.
|
|
263
|
2020-01-03 18:32:31,862+01 [Thread-9] DEBUG o.o.transport.httpcore.HttpUtils:112 - HTTP Response:
|
|
264
|
HTTP/1.1 302 Found
|
|
265
|
X-Backside-Transport: OK OK
|
|
266
|
X-Cnection: close
|
|
267
|
Date: Fri, 03 Jan 2020 17:32:31 GMT
|
|
268
|
X-Powered-By: Servlet/3.0
|
|
269
|
Location: https://eid1.eid-service.de:443/gov_autent/async?SAMLRequest=rVbZcptKEP0VFXlUSawSgrKcAiEbjFbAQvCSYhkhJDYxw%2Bavz9iWE%2FsmNzdJ3Req6Ok%2B3afPoYabz22a9GpQwjjPpgQ9pIgeyII8jLNoSjxad4MJ8fn2BnppwhSiVKFjZoBLBSDq4cIMiq8nU6IqMzH3YAzFzEsBFFEgmtJyITJDSizKHOVBnhA9CUJQItxqlmewSkFpgrKOA%2FBoLKbEEaECiiTZNM0QwNeDQVjWwxCQ6yyJM6DEIIMI2MAnQRyWABYYBhA9Bc8TZx564fAGgzPoIX4MrlAYRuQ4lozy%2BotXIZAh0oNdFhC9u7wMwAu3KYHKCgNqypT4MmaDMKQOgPK4gPZGNMXxB4HzqZFP0aHAPKfBjQdhXIMpcfAS%2BBKBFdDwkF6GpgRDMdSAogcUa9G8yDIiww8FduQSvc11JXKcva76V%2FvzX5OgqFrWZmCAMC5BgIje7k02nERcRRJfJijfq%2FNrcO9NEuL2vQAhqBAMjmBQ4kWB7MUh%2BLWssuhZjzd9SKxteEO%2Bb%2F3NLfMWFz4PCG9vsA7iPAvKrkAgfG%2Bjb0nXiXHiq4R4Dh%2FGQ7%2FKwpeGmkJiji0253cgxUPete754FvhM4GGHeZlRDIURZMUR%2BIsnPGJ6FldAX4jcZ6AFDP%2FR0s85xKgYx72pCTKyxgd09%2FA8gCkmckg8LHX%2Fmxa8vYmhKIOOi075NfaEP5LJUVSwnNlCOPo0w%2B7wiB%2F2Pz%2FoF5Cb5B7oBik0YEuiBc6Shxh4X8T7AMpePRo4s%2FWgDdI%2FpTGld0sLrCrn430IbDzkgrcquo2qB3XNGIETtnZMhYkA%2B%2FvYHKu5Pkl1Eg%2BPc6ZyuTM4I6TpLHVLeZzVRFoZ6Jzykgpjfa0M1fWablP2UnIzexOBTuaO%2FD1bEVGpDOh1bTm9od53jj0KSbZy4yauT6VN%2BN4hZ7OjNkJM%2FPB5M7z87mk9TMURju1mezthYCcitfXDi23hb7Idg%2FYsKdzMDu4EnL15F5RDXuk86tk0zYJnBybpwNFCsuiKzpjzitjMOa0S33iWybydRZYtH0B1qbtmn3qOMjNZSRc7lwBrf1Abtqus8CqDU%2FKnDLunM1Ogwg%2B9b3HNnZYZ%2Bx0RtPowbbyTwZdcTLanDuqUydWtI26JIsfGndstY%2BXM7cMXGk6vUryftUfQq9ykD8YGMe%2Bfw4%2FCPh39n4%2FBGrnc71rcykc7bY%2BBbKVfPZ9i3q03D0fXS7FoT4tBb1q7kx%2F51Z1VO6XAhJQn1KLhJeUrRavVeNg1rU51mh%2FGbn7M%2FNgPCwdz6DCRf5kMSVdOuzeX9lbiS4L0DTCBl9dzCaI5H7MVPLYYKntrEwWhh2XI5SM0HbU1wUFVQtVVtrFKKcTKQk0ybK72i6d3YxdyLu9EQols3zSObtbb%2FwjKMxIfdI9tnFD016vzUmzWYOksoJtyyG7qTWvT6Nx5Z75I2OklCPLe22CYJfaE0Zb3PNw2Q9d6V6ON4lEzvhZrQbFclkxfMf17wursNcdPclcIQpNdzlLTNMG9mHhdpGwU6VVtl2MV1RiFczpyZjsyN1K32snj63UNh6lDsd51dlxRyNl5Zcn59TPHb7y%2BK1ptHaKN5iWjK6HEy32Myqz%2BZWcJnF3Xtf5vavN3A1v8Jz0dx66Bv%2F7Nrq93mkfbzHyJ%2F9Bt18B&Signature=U1r%2F5KjrZK3CNzIXOWhdAroI0y%2FicsuBe8UBTLSfyUK7UFHeYPYEH1Y1ybY%2B5VemZ1R8IMV2vkqCG0E5T6wNO6LWen6PMXryIFlv7nIPyNyH9DRgnSEduJ199I0WCLR0rcV8CvDbzDRX6%2Ba3D2WWBukS8tKrjZp99m9WuvJqGyF7Ec4aeNvrlxsY0SVCCTh9iL9YAMitcknzpvrbU0AscRjS8ieaS2m2oKq8i7Tdq80H1MH6zf3eP%2BTt6zmBV%2B2MCyUKkzGRBYKF5FmLKjxeF0HLS2U%2FFaVAK0q39mFiyqJNmLfhn5ZxW0ntg1sPVwwuQMrnXjSDrPH3naS4jNXbCA%3D%3D&SigAlg=http%3A%2F%2Fwww.w3.org%2F2001%2F04%2Fxmldsig-more%23rsa-sha256
|
|
270
|
Set-Cookie: JSESSIONID=0000rhtqiMzSc-J6vvLZWMIRTGM+17emeff5r; Path=/
|
|
271
|
Expires: Thu, 01 Dec 1994 16:00:00 GMT
|
|
272
|
Cache-Control: no-cache="set-cookie, set-cookie2"
|
|
273
|
Vary: Accept-Encoding,User-Agent
|
|
274
|
Content-Language: de-DE
|
|
275
|
X-Global-Transaction-ID: 29de2d165e0f7ab15b212d0d
|
|
276
|
|
|
277
|
|
|
278
|
2020-01-03 18:32:31,862+01 [Thread-9] INFO o.o.c.t.ClientCertDefaultTlsClient:298 - TLS warning sent.
|
|
279
|
2020-01-03 18:32:31,862+01 [Thread-9] INFO o.o.c.t.ClientCertDefaultTlsClient:300 - TLS(WARN): Close [close_notify=0] --> Connection closed
|
|
280
|
2020-01-03 18:32:31,862+01 [Thread-9] ERROR o.o.addons.activate.ActivateAction:422 - Failed to retrieve the TCToken.
|
|
281
|
2020-01-03 18:32:31,877+01 [Thread-9] DEBUG o.o.addons.activate.ActivateAction:423 - Failed to retrieve the TCToken.
|
|
282
|
org.openecard.binding.tctoken.ex.TCTokenRetrievalException: Failed to retrieve the TCToken.
|
|
283
|
at org.openecard.binding.tctoken.TCTokenContext.generateTCToken(TCTokenContext.java:76)
|
|
284
|
at org.openecard.binding.tctoken.TCTokenRequest.parseTCTokenRequestURI(TCTokenRequest.java:197)
|
|
285
|
at org.openecard.binding.tctoken.TCTokenRequest.convert(TCTokenRequest.java:116)
|
|
286
|
at org.openecard.addons.activate.ActivateAction.processTcToken(ActivateAction.java:408)
|
|
287
|
at org.openecard.addons.activate.ActivateAction.processRequest(ActivateAction.java:265)
|
|
288
|
at org.openecard.addons.activate.ActivateAction.checkRequestParameters(ActivateAction.java:246)
|
|
289
|
at org.openecard.addons.activate.ActivateAction.execute(ActivateAction.java:127)
|
|
290
|
at org.openecard.addon.bind.AppPluginActionProxy.execute(AppPluginActionProxy.java:55)
|
|
291
|
at org.openecard.control.binding.http.handler.HttpAppPluginActionHandler.handle(HttpAppPluginActionHandler.java:127)
|
|
292
|
at org.openecard.apache.http.protocol.HttpService.doService(HttpService.java:437)
|
|
293
|
at org.openecard.apache.http.protocol.HttpService.handleRequest(HttpService.java:342)
|
|
294
|
at org.openecard.control.binding.http.HttpService$1.run(HttpService.java:132)
|
|
295
|
Caused by: java.net.SocketException: Software caused connection abort: socket write error
|
|
296
|
at java.net.SocketOutputStream.socketWrite0(Native Method)
|
|
297
|
at java.net.SocketOutputStream.socketWrite(Unknown Source)
|
|
298
|
at java.net.SocketOutputStream.write(Unknown Source)
|
|
299
|
at org.openecard.bouncycastle.tls.RecordStream.writeRecord(RecordStream.java:426)
|
|
300
|
at org.openecard.bouncycastle.tls.TlsProtocol.safeWriteRecord(TlsProtocol.java:686)
|
|
301
|
at org.openecard.bouncycastle.tls.TlsProtocol.raiseAlertWarning(TlsProtocol.java:1205)
|
|
302
|
at org.openecard.bouncycastle.tls.TlsProtocol.handleClose(TlsProtocol.java:188)
|
|
303
|
at org.openecard.bouncycastle.tls.TlsProtocol.close(TlsProtocol.java:1280)
|
|
304
|
at org.openecard.binding.tctoken.ResourceContext.getStreamInt(ResourceContext.java:309)
|
|
305
|
at org.openecard.binding.tctoken.ResourceContext.getStream(ResourceContext.java:198)
|
|
306
|
at org.openecard.binding.tctoken.ResourceContext.getStream(ResourceContext.java:175)
|
|
307
|
at org.openecard.binding.tctoken.TCTokenContext.generateTCToken(TCTokenContext.java:73)
|
|
308
|
... 11 common frames omitted
|
|
309
|
2020-01-03 18:32:31,877+01 [Thread-9] DEBUG o.o.addons.activate.ActivateAction:424 - Returning result:
|
|
310
|
BindingResult <RESOURCE_UNAVAILABLE, 'Das TCToken konnte nicht empfangen werden.'>
|
