From 60dd7d1b670d76e4419037a9cbe1e3761a1bfb1c Mon Sep 17 00:00:00 2001 From: Siim Kallas Date: Wed, 21 Apr 2021 22:31:08 +0300 Subject: [PATCH] feat: pino instrumentation (#432) --- .../.eslintignore | 1 + .../.eslintrc.js | 7 + .../.npmignore | 4 + .../LICENSE | 201 +++++++++++++ .../README.md | 76 +++++ .../package.json | 71 +++++ .../src/index.ts | 17 ++ .../src/pino.ts | 171 +++++++++++ .../src/types.ts | 28 ++ .../src/version.ts | 18 ++ .../test/pino.test.ts | 280 ++++++++++++++++++ .../tsconfig.json | 11 + 12 files changed, 885 insertions(+) create mode 100644 plugins/node/opentelemetry-instrumentation-pino/.eslintignore create mode 100644 plugins/node/opentelemetry-instrumentation-pino/.eslintrc.js create mode 100644 plugins/node/opentelemetry-instrumentation-pino/.npmignore create mode 100644 plugins/node/opentelemetry-instrumentation-pino/LICENSE create mode 100644 plugins/node/opentelemetry-instrumentation-pino/README.md create mode 100644 plugins/node/opentelemetry-instrumentation-pino/package.json create mode 100644 plugins/node/opentelemetry-instrumentation-pino/src/index.ts create mode 100644 plugins/node/opentelemetry-instrumentation-pino/src/pino.ts create mode 100644 plugins/node/opentelemetry-instrumentation-pino/src/types.ts create mode 100644 plugins/node/opentelemetry-instrumentation-pino/src/version.ts create mode 100644 plugins/node/opentelemetry-instrumentation-pino/test/pino.test.ts create mode 100644 plugins/node/opentelemetry-instrumentation-pino/tsconfig.json diff --git a/plugins/node/opentelemetry-instrumentation-pino/.eslintignore b/plugins/node/opentelemetry-instrumentation-pino/.eslintignore new file mode 100644 index 0000000000..378eac25d3 --- /dev/null +++ b/plugins/node/opentelemetry-instrumentation-pino/.eslintignore @@ -0,0 +1 @@ +build diff --git a/plugins/node/opentelemetry-instrumentation-pino/.eslintrc.js b/plugins/node/opentelemetry-instrumentation-pino/.eslintrc.js new file mode 100644 index 0000000000..6aeb0710ef --- /dev/null +++ b/plugins/node/opentelemetry-instrumentation-pino/.eslintrc.js @@ -0,0 +1,7 @@ +module.exports = { + "env": { + "mocha": true, + "node": true + }, + ...require('../../../eslint.config.js'), +} diff --git a/plugins/node/opentelemetry-instrumentation-pino/.npmignore b/plugins/node/opentelemetry-instrumentation-pino/.npmignore new file mode 100644 index 0000000000..9505ba9450 --- /dev/null +++ b/plugins/node/opentelemetry-instrumentation-pino/.npmignore @@ -0,0 +1,4 @@ +/bin +/coverage +/doc +/test diff --git a/plugins/node/opentelemetry-instrumentation-pino/LICENSE b/plugins/node/opentelemetry-instrumentation-pino/LICENSE new file mode 100644 index 0000000000..261eeb9e9f --- /dev/null +++ b/plugins/node/opentelemetry-instrumentation-pino/LICENSE @@ -0,0 +1,201 @@ + Apache License + Version 2.0, January 2004 + http://www.apache.org/licenses/ + + TERMS AND CONDITIONS FOR USE, REPRODUCTION, AND DISTRIBUTION + + 1. Definitions. + + "License" shall mean the terms and conditions for use, reproduction, + and distribution as defined by Sections 1 through 9 of this document. + + "Licensor" shall mean the copyright owner or entity authorized by + the copyright owner that is granting the License. + + "Legal Entity" shall mean the union of the acting entity and all + other entities that control, are controlled by, or are under common + control with that entity. For the purposes of this definition, + "control" means (i) the power, direct or indirect, to cause the + direction or management of such entity, whether by contract or + otherwise, or (ii) ownership of fifty percent (50%) or more of the + outstanding shares, or (iii) beneficial ownership of such entity. + + "You" (or "Your") shall mean an individual or Legal Entity + exercising permissions granted by this License. + + "Source" form shall mean the preferred form for making modifications, + including but not limited to software source code, documentation + source, and configuration files. + + "Object" form shall mean any form resulting from mechanical + transformation or translation of a Source form, including but + not limited to compiled object code, generated documentation, + and conversions to other media types. + + "Work" shall mean the work of authorship, whether in Source or + Object form, made available under the License, as indicated by a + copyright notice that is included in or attached to the work + (an example is provided in the Appendix below). + + "Derivative Works" shall mean any work, whether in Source or Object + form, that is based on (or derived from) the Work and for which the + editorial revisions, annotations, elaborations, or other modifications + represent, as a whole, an original work of authorship. For the purposes + of this License, Derivative Works shall not include works that remain + separable from, or merely link (or bind by name) to the interfaces of, + the Work and Derivative Works thereof. + + "Contribution" shall mean any work of authorship, including + the original version of the Work and any modifications or additions + to that Work or Derivative Works thereof, that is intentionally + submitted to Licensor for inclusion in the Work by the copyright owner + or by an individual or Legal Entity authorized to submit on behalf of + the copyright owner. For the purposes of this definition, "submitted" + means any form of electronic, verbal, or written communication sent + to the Licensor or its representatives, including but not limited to + communication on electronic mailing lists, source code control systems, + and issue tracking systems that are managed by, or on behalf of, the + Licensor for the purpose of discussing and improving the Work, but + excluding communication that is conspicuously marked or otherwise + designated in writing by the copyright owner as "Not a Contribution." + + "Contributor" shall mean Licensor and any individual or Legal Entity + on behalf of whom a Contribution has been received by Licensor and + subsequently incorporated within the Work. + + 2. Grant of Copyright License. Subject to the terms and conditions of + this License, each Contributor hereby grants to You a perpetual, + worldwide, non-exclusive, no-charge, royalty-free, irrevocable + copyright license to reproduce, prepare Derivative Works of, + publicly display, publicly perform, sublicense, and distribute the + Work and such Derivative Works in Source or Object form. + + 3. Grant of Patent License. Subject to the terms and conditions of + this License, each Contributor hereby grants to You a perpetual, + worldwide, non-exclusive, no-charge, royalty-free, irrevocable + (except as stated in this section) patent license to make, have made, + use, offer to sell, sell, import, and otherwise transfer the Work, + where such license applies only to those patent claims licensable + by such Contributor that are necessarily infringed by their + Contribution(s) alone or by combination of their Contribution(s) + with the Work to which such Contribution(s) was submitted. If You + institute patent litigation against any entity (including a + cross-claim or counterclaim in a lawsuit) alleging that the Work + or a Contribution incorporated within the Work constitutes direct + or contributory patent infringement, then any patent licenses + granted to You under this License for that Work shall terminate + as of the date such litigation is filed. + + 4. Redistribution. You may reproduce and distribute copies of the + Work or Derivative Works thereof in any medium, with or without + modifications, and in Source or Object form, provided that You + meet the following conditions: + + (a) You must give any other recipients of the Work or + Derivative Works a copy of this License; and + + (b) You must cause any modified files to carry prominent notices + stating that You changed the files; and + + (c) You must retain, in the Source form of any Derivative Works + that You distribute, all copyright, patent, trademark, and + attribution notices from the Source form of the Work, + excluding those notices that do not pertain to any part of + the Derivative Works; and + + (d) If the Work includes a "NOTICE" text file as part of its + distribution, then any Derivative Works that You distribute must + include a readable copy of the attribution notices contained + within such NOTICE file, excluding those notices that do not + pertain to any part of the Derivative Works, in at least one + of the following places: within a NOTICE text file distributed + as part of the Derivative Works; within the Source form or + documentation, if provided along with the Derivative Works; or, + within a display generated by the Derivative Works, if and + wherever such third-party notices normally appear. The contents + of the NOTICE file are for informational purposes only and + do not modify the License. You may add Your own attribution + notices within Derivative Works that You distribute, alongside + or as an addendum to the NOTICE text from the Work, provided + that such additional attribution notices cannot be construed + as modifying the License. + + You may add Your own copyright statement to Your modifications and + may provide additional or different license terms and conditions + for use, reproduction, or distribution of Your modifications, or + for any such Derivative Works as a whole, provided Your use, + reproduction, and distribution of the Work otherwise complies with + the conditions stated in this License. + + 5. Submission of Contributions. Unless You explicitly state otherwise, + any Contribution intentionally submitted for inclusion in the Work + by You to the Licensor shall be under the terms and conditions of + this License, without any additional terms or conditions. + Notwithstanding the above, nothing herein shall supersede or modify + the terms of any separate license agreement you may have executed + with Licensor regarding such Contributions. + + 6. Trademarks. This License does not grant permission to use the trade + names, trademarks, service marks, or product names of the Licensor, + except as required for reasonable and customary use in describing the + origin of the Work and reproducing the content of the NOTICE file. + + 7. Disclaimer of Warranty. Unless required by applicable law or + agreed to in writing, Licensor provides the Work (and each + Contributor provides its Contributions) on an "AS IS" BASIS, + WITHOUT WARRANTIES OR CONDITIONS OF ANY KIND, either express or + implied, including, without limitation, any warranties or conditions + of TITLE, NON-INFRINGEMENT, MERCHANTABILITY, or FITNESS FOR A + PARTICULAR PURPOSE. You are solely responsible for determining the + appropriateness of using or redistributing the Work and assume any + risks associated with Your exercise of permissions under this License. + + 8. Limitation of Liability. In no event and under no legal theory, + whether in tort (including negligence), contract, or otherwise, + unless required by applicable law (such as deliberate and grossly + negligent acts) or agreed to in writing, shall any Contributor be + liable to You for damages, including any direct, indirect, special, + incidental, or consequential damages of any character arising as a + result of this License or out of the use or inability to use the + Work (including but not limited to damages for loss of goodwill, + work stoppage, computer failure or malfunction, or any and all + other commercial damages or losses), even if such Contributor + has been advised of the possibility of such damages. + + 9. Accepting Warranty or Additional Liability. While redistributing + the Work or Derivative Works thereof, You may choose to offer, + and charge a fee for, acceptance of support, warranty, indemnity, + or other liability obligations and/or rights consistent with this + License. However, in accepting such obligations, You may act only + on Your own behalf and on Your sole responsibility, not on behalf + of any other Contributor, and only if You agree to indemnify, + defend, and hold each Contributor harmless for any liability + incurred by, or claims asserted against, such Contributor by reason + of your accepting any such warranty or additional liability. + + END OF TERMS AND CONDITIONS + + APPENDIX: How to apply the Apache License to your work. + + To apply the Apache License to your work, attach the following + boilerplate notice, with the fields enclosed by brackets "[]" + replaced with your own identifying information. (Don't include + the brackets!) The text should be enclosed in the appropriate + comment syntax for the file format. We also recommend that a + file or class name and description of purpose be included on the + same "printed page" as the copyright notice for easier + identification within third-party archives. + + Copyright [yyyy] [name of copyright owner] + + Licensed under the Apache License, Version 2.0 (the "License"); + you may not use this file except in compliance with the License. + You may obtain a copy of the License at + + http://www.apache.org/licenses/LICENSE-2.0 + + Unless required by applicable law or agreed to in writing, software + distributed under the License is distributed on an "AS IS" BASIS, + WITHOUT WARRANTIES OR CONDITIONS OF ANY KIND, either express or implied. + See the License for the specific language governing permissions and + limitations under the License. diff --git a/plugins/node/opentelemetry-instrumentation-pino/README.md b/plugins/node/opentelemetry-instrumentation-pino/README.md new file mode 100644 index 0000000000..cb3bdd8148 --- /dev/null +++ b/plugins/node/opentelemetry-instrumentation-pino/README.md @@ -0,0 +1,76 @@ +# OpenTelemetry instrumentation for pino + +[![NPM Published Version][npm-img]][npm-url] +[![dependencies][dependencies-image]][dependencies-url] +[![devDependencies][devDependencies-image]][devDependencies-url] +[![Apache License][license-image]][license-image] + +This module provides automatic instrumentation for injection of trace context to [`pino`](https://www.npmjs.com/package/pino). + +## Installation + +```bash +npm install --save @opentelemetry/instrumentation-pino +``` + +## Usage + +```js +const { NodeTracerProvider } = require('@opentelemetry/node'); +const { PinoInstrumentation } = require('@opentelemetry/instrumentation-pino'); +const { registerInstrumentations } = require('@opentelemetry/instrumentation'); + +const provider = new NodeTracerProvider(); +provider.register(); + +registerInstrumentations({ + instrumentations: [ + new PinoInstrumentation({ + // Optional hook to insert additional context to log object. + logHook: (span, record) => { + record['resource.service.name'] = provider.resource.attributes['service.name']; + }, + }), + // other instrumentations + ], + tracerProvider: provider, +}); + +const pino = require('pino'); +const logger = pino(); +logger.info('foobar'); +// {"msg":"foobar","trace_id":"fc30029f30df383a4090d3189fe0ffdf","span_id":"625fa861d19d1056","trace_flags":"01", ...} +``` + +### Fields added to pino log objects + +For the current active span, the following fields are injected: +* `trace_id` +* `span_id` +* `trace_flags` + +When no span context is active or the span context is invalid, injection is skipped. + +### Supported versions + +`>5.14.0` and `6.x` + +## Useful links + +- For more information on OpenTelemetry, visit: +- For more about OpenTelemetry JavaScript: +- For help or feedback on this project, join us in [GitHub Discussions][discussions-url] + +## License + +Apache 2.0 - See [LICENSE][license-url] for more information. + +[discussions-url]: https://github.com/open-telemetry/opentelemetry-js/discussions +[license-url]: https://github.com/open-telemetry/opentelemetry-js-contrib/blob/main/LICENSE +[license-image]: https://img.shields.io/badge/license-Apache_2.0-green.svg?style=flat +[dependencies-image]: https://status.david-dm.org/gh/open-telemetry/opentelemetry-js-contrib.svg?path=plugins%2Fnode%2Fopentelemetry-instrumentation-pino +[dependencies-url]: https://david-dm.org/open-telemetry/opentelemetry-js-contrib?path=plugins%2Fnode%2Fopentelemetry-instrumentation-pino +[devDependencies-image]: https://status.david-dm.org/gh/open-telemetry/opentelemetry-js-contrib.svg?path=plugins%2Fnode%2Fopentelemetry-instrumentation-pino&type=dev +[devDependencies-url]: https://david-dm.org/open-telemetry/opentelemetry-js-contrib?path=plugins%2Fnode%2Fopentelemetry-instrumentation-pino&type=dev +[npm-url]: https://www.npmjs.com/package/@opentelemetry/instrumentation-pino +[npm-img]: https://badge.fury.io/js/%40opentelemetry%2Finstrumentation-pino.svg diff --git a/plugins/node/opentelemetry-instrumentation-pino/package.json b/plugins/node/opentelemetry-instrumentation-pino/package.json new file mode 100644 index 0000000000..ae2b1e7878 --- /dev/null +++ b/plugins/node/opentelemetry-instrumentation-pino/package.json @@ -0,0 +1,71 @@ +{ + "name": "@opentelemetry/instrumentation-pino", + "version": "0.15.0", + "description": "OpenTelemetry instrumentation for pino", + "main": "build/src/index.js", + "types": "build/src/index.d.ts", + "repository": "open-telemetry/opentelemetry-js-contrib", + "scripts": { + "test": "nyc ts-mocha -p tsconfig.json 'test/**/*.test.ts'", + "tdd": "npm run test -- --watch-extensions ts --watch", + "clean": "rimraf build/*", + "lint": "eslint . --ext .ts", + "lint:fix": "eslint . --ext .ts --fix", + "codecov": "nyc report --reporter=json && codecov -f coverage/*.json -p ../../", + "precompile": "tsc --version", + "prepare": "npm run compile", + "version:update": "node ../../../scripts/version-update.js", + "compile": "npm run version:update && tsc -p ." + }, + "keywords": [ + "opentelemetry", + "logging", + "nodejs", + "tracing", + "profiling", + "instrumentation", + "pino" + ], + "author": "OpenTelemetry Authors", + "license": "Apache-2.0", + "engines": { + "node": ">=8.5.0" + }, + "files": [ + "build/src/**/*.js", + "build/src/**/*.d.ts", + "doc", + "LICENSE", + "README.md" + ], + "publishConfig": { + "access": "public" + }, + "devDependencies": { + "@opentelemetry/context-async-hooks": "0.18.2", + "@opentelemetry/node": "0.18.2", + "@opentelemetry/tracing": "0.18.2", + "@types/mocha": "7.0.2", + "@types/node": "14.0.27", + "@types/pino": "^6.3.7", + "@types/sinon": "9.0.4", + "@types/semver": "^7.3.4", + "codecov": "3.7.2", + "gts": "3.1.0", + "mocha": "7.2.0", + "nyc": "15.1.0", + "rimraf": "3.0.2", + "sinon": "9.0.2", + "ts-mocha": "8.0.0", + "ts-node": "9.0.0", + "tslint-consistent-codestyle": "1.16.0", + "tslint-microsoft-contrib": "6.2.0", + "typescript": "4.1.3", + "pino": "^6.11.2" + }, + "dependencies": { + "@opentelemetry/api": "^0.18.0", + "@opentelemetry/instrumentation": "^0.18.0", + "semver": "^7.3.5" + } +} diff --git a/plugins/node/opentelemetry-instrumentation-pino/src/index.ts b/plugins/node/opentelemetry-instrumentation-pino/src/index.ts new file mode 100644 index 0000000000..913efd7ecb --- /dev/null +++ b/plugins/node/opentelemetry-instrumentation-pino/src/index.ts @@ -0,0 +1,17 @@ +/* + * Copyright The OpenTelemetry Authors + * + * Licensed under the Apache License, Version 2.0 (the "License"); + * you may not use this file except in compliance with the License. + * You may obtain a copy of the License at + * + * https://www.apache.org/licenses/LICENSE-2.0 + * + * Unless required by applicable law or agreed to in writing, software + * distributed under the License is distributed on an "AS IS" BASIS, + * WITHOUT WARRANTIES OR CONDITIONS OF ANY KIND, either express or implied. + * See the License for the specific language governing permissions and + * limitations under the License. + */ + +export * from './pino'; diff --git a/plugins/node/opentelemetry-instrumentation-pino/src/pino.ts b/plugins/node/opentelemetry-instrumentation-pino/src/pino.ts new file mode 100644 index 0000000000..6442047a13 --- /dev/null +++ b/plugins/node/opentelemetry-instrumentation-pino/src/pino.ts @@ -0,0 +1,171 @@ +/* + * Copyright The OpenTelemetry Authors + * + * Licensed under the Apache License, Version 2.0 (the "License"); + * you may not use this file except in compliance with the License. + * You may obtain a copy of the License at + * + * https://www.apache.org/licenses/LICENSE-2.0 + * + * Unless required by applicable law or agreed to in writing, software + * distributed under the License is distributed on an "AS IS" BASIS, + * WITHOUT WARRANTIES OR CONDITIONS OF ANY KIND, either express or implied. + * See the License for the specific language governing permissions and + * limitations under the License. + */ + +import { + context, + diag, + getSpan, + isSpanContextValid, + Span, +} from '@opentelemetry/api'; +import { + InstrumentationBase, + InstrumentationNodeModuleDefinition, + safeExecuteInTheMiddle, +} from '@opentelemetry/instrumentation'; +import { Pino, PinoInstrumentationConfig } from './types'; +import { VERSION } from './version'; +import type * as pino from 'pino'; + +const pinoVersions = ['>=5.14.0 <7']; + +export class PinoInstrumentation extends InstrumentationBase { + // TODO: https://github.com/open-telemetry/opentelemetry-js/issues/2131 + _isEnabled: boolean = false; + + constructor(config: PinoInstrumentationConfig = {}) { + super('@opentelemetry/instrumentation-pino', VERSION, config); + } + + protected init() { + return [ + new InstrumentationNodeModuleDefinition( + 'pino', + pinoVersions, + pinoModule => { + const instrumentation = this; + const patchedPino = Object.assign((...args: unknown[]) => { + if (args.length == 0) { + return pinoModule({ mixin: instrumentation._getMixinFunction() }); + } + + if (args.length == 1) { + // eslint-disable-next-line @typescript-eslint/no-explicit-any + const optsOrStream = args[0] as any; + if ( + typeof optsOrStream === 'string' || + typeof optsOrStream?.write === 'function' + ) { + args.splice(0, 0, { + mixin: instrumentation._getMixinFunction(), + }); + return pinoModule(...(args as Parameters)); + } + } + + args[0] = instrumentation._combineOptions( + args[0] as pino.LoggerOptions + ); + + return pinoModule(...(args as Parameters)); + }, pinoModule); + + return patchedPino; + }, + () => { + this._isEnabled = false; + } + ), + ]; + } + + getConfig(): PinoInstrumentationConfig { + return this._config; + } + + setConfig(config: PinoInstrumentationConfig) { + this._config = config; + } + + enable() { + super.enable(); + this._isEnabled = true; + } + + disable() { + super.disable(); + this._isEnabled = false; + } + + private _callHook(span: Span, record: Record) { + const hook = this.getConfig().logHook; + + if (!hook) { + return; + } + + safeExecuteInTheMiddle( + () => hook(span, record), + err => { + if (err) { + diag.error('pino instrumentation: error calling logHook', err); + } + }, + true + ); + } + + private _getMixinFunction() { + const instrumentation = this; + return function otelMixin() { + if (!instrumentation._isEnabled) { + return {}; + } + + const span = getSpan(context.active()); + + if (!span) { + return {}; + } + + const spanContext = span.context(); + + if (!isSpanContextValid(spanContext)) { + return {}; + } + + const record = { + trace_id: spanContext.traceId, + span_id: spanContext.spanId, + trace_flags: `0${spanContext.traceFlags.toString(16)}`, + }; + + instrumentation._callHook(span, record); + + return record; + }; + } + + private _combineOptions(options?: pino.LoggerOptions) { + if (options === undefined) { + return { mixin: this._getMixinFunction() }; + } + + if (options.mixin === undefined) { + options.mixin = this._getMixinFunction(); + return options; + } + + const originalMixin = options.mixin; + const otelMixin = this._getMixinFunction(); + + options.mixin = () => { + return Object.assign(otelMixin(), originalMixin()); + }; + + return options; + } +} diff --git a/plugins/node/opentelemetry-instrumentation-pino/src/types.ts b/plugins/node/opentelemetry-instrumentation-pino/src/types.ts new file mode 100644 index 0000000000..c7d49296bc --- /dev/null +++ b/plugins/node/opentelemetry-instrumentation-pino/src/types.ts @@ -0,0 +1,28 @@ +/* + * Copyright The OpenTelemetry Authors + * + * Licensed under the Apache License, Version 2.0 (the "License"); + * you may not use this file except in compliance with the License. + * You may obtain a copy of the License at + * + * https://www.apache.org/licenses/LICENSE-2.0 + * + * Unless required by applicable law or agreed to in writing, software + * distributed under the License is distributed on an "AS IS" BASIS, + * WITHOUT WARRANTIES OR CONDITIONS OF ANY KIND, either express or implied. + * See the License for the specific language governing permissions and + * limitations under the License. + */ + +import { Span } from '@opentelemetry/api'; +import { InstrumentationConfig } from '@opentelemetry/instrumentation'; +import type * as pino from 'pino'; + +// eslint-disable-next-line @typescript-eslint/no-explicit-any +export type LogHookFunction = (span: Span, record: Record) => void; + +export interface PinoInstrumentationConfig extends InstrumentationConfig { + logHook?: LogHookFunction; +} + +export type Pino = typeof pino; diff --git a/plugins/node/opentelemetry-instrumentation-pino/src/version.ts b/plugins/node/opentelemetry-instrumentation-pino/src/version.ts new file mode 100644 index 0000000000..1e4172026f --- /dev/null +++ b/plugins/node/opentelemetry-instrumentation-pino/src/version.ts @@ -0,0 +1,18 @@ +/* + * Copyright The OpenTelemetry Authors + * + * Licensed under the Apache License, Version 2.0 (the "License"); + * you may not use this file except in compliance with the License. + * You may obtain a copy of the License at + * + * https://www.apache.org/licenses/LICENSE-2.0 + * + * Unless required by applicable law or agreed to in writing, software + * distributed under the License is distributed on an "AS IS" BASIS, + * WITHOUT WARRANTIES OR CONDITIONS OF ANY KIND, either express or implied. + * See the License for the specific language governing permissions and + * limitations under the License. + */ + +// this is autogenerated file, see scripts/version-update.js +export const VERSION = '0.15.0'; diff --git a/plugins/node/opentelemetry-instrumentation-pino/test/pino.test.ts b/plugins/node/opentelemetry-instrumentation-pino/test/pino.test.ts new file mode 100644 index 0000000000..a322e68cca --- /dev/null +++ b/plugins/node/opentelemetry-instrumentation-pino/test/pino.test.ts @@ -0,0 +1,280 @@ +/* + * Copyright The OpenTelemetry Authors + * + * Licensed under the Apache License, Version 2.0 (the "License"); + * you may not use this file except in compliance with the License. + * You may obtain a copy of the License at + * + * https://www.apache.org/licenses/LICENSE-2.0 + * + * Unless required by applicable law or agreed to in writing, software + * distributed under the License is distributed on an "AS IS" BASIS, + * WITHOUT WARRANTIES OR CONDITIONS OF ANY KIND, either express or implied. + * See the License for the specific language governing permissions and + * limitations under the License. + */ + +import { + InMemorySpanExporter, + SimpleSpanProcessor, +} from '@opentelemetry/tracing'; +import { + context, + getSpan, + setSpan, + NoopTracerProvider, + Span, +} from '@opentelemetry/api'; +import { NodeTracerProvider } from '@opentelemetry/node'; +import { AsyncHooksContextManager } from '@opentelemetry/context-async-hooks'; +import { Writable } from 'stream'; +import * as assert from 'assert'; +import * as sinon from 'sinon'; +import type * as Pino from 'pino'; + +import { PinoInstrumentation } from '../src/pino'; + +const memoryExporter = new InMemorySpanExporter(); +const provider = new NodeTracerProvider(); +const tracer = provider.getTracer('default'); +provider.addSpanProcessor(new SimpleSpanProcessor(memoryExporter)); +context.setGlobalContextManager(new AsyncHooksContextManager()); + +const kMessage = 'log-message'; + +describe('PinoInstrumentation', () => { + let stream: Writable; + let writeSpy: sinon.SinonSpy; + let pino: typeof Pino; + let instrumentation: PinoInstrumentation; + let logger: Pino.Logger; + + function assertRecord(record: any, span: Span) { + const { traceId, spanId, traceFlags } = span.context(); + assert.strictEqual(record['trace_id'], traceId); + assert.strictEqual(record['span_id'], spanId); + assert.strictEqual(record['trace_flags'], `0${traceFlags.toString(16)}`); + assert.strictEqual(kMessage, record['msg']); + } + + function assertInjection(span: Span) { + sinon.assert.calledOnce(writeSpy); + const record = JSON.parse(writeSpy.firstCall.args[0].toString()); + assertRecord(record, span); + return record; + } + + function testInjection(span: Span) { + logger.info(kMessage); + return assertInjection(span); + } + + function testNoInjection() { + logger.info(kMessage); + sinon.assert.calledOnce(writeSpy); + const record = JSON.parse(writeSpy.firstCall.args[0].toString()); + assert.strictEqual(record['trace_id'], undefined); + assert.strictEqual(record['span_id'], undefined); + assert.strictEqual(record['trace_flags'], undefined); + assert.strictEqual(kMessage, record['msg']); + return record; + } + + function init() { + stream = new Writable(); + stream._write = () => {}; + writeSpy = sinon.spy(stream, 'write'); + logger = pino(stream); + } + + before(() => { + instrumentation = new PinoInstrumentation(); + instrumentation.enable(); + pino = require('pino'); + }); + + describe('enabled instrumentation', () => { + beforeEach(() => { + init(); + }); + + it('injects span context to records', () => { + const span = tracer.startSpan('abc'); + context.with(setSpan(context.active(), span), () => { + testInjection(span); + }); + }); + + it('injects span context to child logger records', () => { + const span = tracer.startSpan('abc'); + context.with(setSpan(context.active(), span), () => { + const child = logger.child({ foo: 42 }); + child.info(kMessage); + assertInjection(span); + }); + }); + + it('calls the users log hook', () => { + const span = tracer.startSpan('abc'); + instrumentation.setConfig({ + enabled: true, + logHook: (_span, record) => { + record['resource.service.name'] = 'test-service'; + }, + }); + context.with(setSpan(context.active(), span), () => { + const record = testInjection(span); + assert.strictEqual(record['resource.service.name'], 'test-service'); + }); + }); + + it('does not inject span context if no span is active', () => { + assert.strictEqual(getSpan(context.active()), undefined); + testNoInjection(); + }); + + it('does not inject span context if span context is invalid', () => { + const noopTracer = new NoopTracerProvider().getTracer('noop'); + const span = noopTracer.startSpan('noop'); + context.with(setSpan(context.active(), span), () => { + testNoInjection(); + }); + }); + + it('does not propagate exceptions from user hooks', () => { + const span = tracer.startSpan('abc'); + instrumentation.setConfig({ + enabled: true, + logHook: () => { + throw new Error('Oops'); + }, + }); + context.with(setSpan(context.active(), span), () => { + testInjection(span); + }); + }); + }); + + describe('logger construction', () => { + let stdoutSpy: sinon.SinonSpy; + + beforeEach(() => { + stream = new Writable(); + stream._write = () => {}; + writeSpy = sinon.spy(stream, 'write'); + stdoutSpy = sinon.spy(process.stdout, 'write'); + }); + + afterEach(() => { + stdoutSpy.restore(); + }); + + it('does not fail when constructing logger without arguments', () => { + logger = pino(); + const span = tracer.startSpan('abc'); + context.with(setSpan(context.active(), span), () => { + logger.info(kMessage); + }); + const record = JSON.parse(stdoutSpy.firstCall.args[0].toString()); + assertRecord(record, span); + }); + + it('preserves user options and adds a mixin', () => { + logger = pino({ name: 'LogLog' }, stream); + + const span = tracer.startSpan('abc'); + context.with(setSpan(context.active(), span), () => { + const record = testInjection(span); + assert.strictEqual(record['name'], 'LogLog'); + }); + }); + + describe('binary arguments', () => { + it('is possible to construct logger with undefined options', () => { + logger = pino((undefined as unknown) as Pino.LoggerOptions, stream); + const span = tracer.startSpan('abc'); + context.with(setSpan(context.active(), span), () => { + testInjection(span); + }); + }); + + it('preserves user mixins', () => { + logger = pino( + { + name: 'LogLog', + mixin: () => ({ a: 2, b: 'bar' }), + }, + stream + ); + + const span = tracer.startSpan('abc'); + context.with(setSpan(context.active(), span), () => { + const record = testInjection(span); + assert.strictEqual(record['a'], 2); + assert.strictEqual(record['b'], 'bar'); + assert.strictEqual(record['name'], 'LogLog'); + }); + }); + + it('ensures user mixin values take precedence', () => { + logger = pino( + { + mixin() { + return { trace_id: '123' }; + }, + }, + stream + ); + + const span = tracer.startSpan('abc'); + context.with(setSpan(context.active(), span), () => { + logger.info(kMessage); + }); + + const record = JSON.parse(writeSpy.firstCall.args[0].toString()); + assert.strictEqual(record['trace_id'], '123'); + }); + }); + }); + + describe('disabled instrumentation', () => { + before(() => { + instrumentation.disable(); + }); + + after(() => { + instrumentation.enable(); + }); + + beforeEach(init); + + it('does not inject span context', () => { + const span = tracer.startSpan('abc'); + context.with(setSpan(context.active(), span), () => { + testNoInjection(); + }); + }); + + it('does not call log hook', () => { + const span = tracer.startSpan('abc'); + instrumentation.setConfig({ + enabled: false, + logHook: (_span, record) => { + record['resource.service.name'] = 'test-service'; + }, + }); + context.with(setSpan(context.active(), span), () => { + const record = testNoInjection(); + assert.strictEqual(record['resource.service.name'], undefined); + }); + }); + + it('injects span context once re-enabled', () => { + instrumentation.enable(); + const span = tracer.startSpan('abc'); + context.with(setSpan(context.active(), span), () => { + testInjection(span); + }); + }); + }); +}); diff --git a/plugins/node/opentelemetry-instrumentation-pino/tsconfig.json b/plugins/node/opentelemetry-instrumentation-pino/tsconfig.json new file mode 100644 index 0000000000..28be80d266 --- /dev/null +++ b/plugins/node/opentelemetry-instrumentation-pino/tsconfig.json @@ -0,0 +1,11 @@ +{ + "extends": "../../../tsconfig.base", + "compilerOptions": { + "rootDir": ".", + "outDir": "build" + }, + "include": [ + "src/**/*.ts", + "test/**/*.ts" + ] +}