builder: mozilla-central_ubuntu64_hw_styloseq_test-dromaeojs-e10s slave: talos-linux64-ix-045 starttime: 1503450283.42 results: success (0) revision: 64a45ee1731c79da9850233a797bf80d3b1a52bd ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-08-22 18:04:43.423269) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-08-22 18:04:43.423720) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-08-22 18:04:43.423994) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-08-22 18:04:43.440830) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-08-22 18:04:43.441219) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=4300f881736b422476174874000001bc-1503450282.909478-95939596 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-08-22 18:04:43-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 229M=0s 2017-08-22 18:04:43 (229 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.103514 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-08-22 18:04:43.560394) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-08-22 18:04:43.560704) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=4300f881736b422476174874000001bc-1503450282.909478-95939596 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.016363 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-08-22 18:04:43.612064) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-08-22 18:04:43.612547) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 64a45ee1731c79da9850233a797bf80d3b1a52bd --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'python archiver_client.py mozharness --repo mozilla-central --rev 64a45ee1731c79da9850233a797bf80d3b1a52bd --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=4300f881736b422476174874000001bc-1503450282.909478-95939596 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-08-22 18:04:43,843 truncating revision to first 12 chars 2017-08-22 18:04:43,843 Setting DEBUG logging. 2017-08-22 18:04:43,843 attempt 1/10 2017-08-22 18:04:43,843 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/64a45ee1731c?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-08-22 18:04:44,728 unpacking tar archive at: mozilla-central-64a45ee1731c/testing/mozharness/ program finished with exit code 0 elapsedTime=1.201245 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-08-22 18:04:44.831574) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-08-22 18:04:44.832059) ========= script_repo_revision: 64a45ee1731c79da9850233a797bf80d3b1a52bd ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-08-22 18:04:44.832586) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-08-22 18:04:44.832971) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-08-22 18:04:44.845953) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 50 secs) (at 2017-08-22 18:04:44.846381) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=4300f881736b422476174874000001bc-1503450282.909478-95939596 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 18:04:45 INFO - MultiFileLogger online at 20170822 18:04:45 in /builds/slave/test 18:04:45 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 18:04:45 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 18:04:45 INFO - {'append_to_log': False, 18:04:45 INFO - 'base_work_dir': '/builds/slave/test', 18:04:45 INFO - 'blob_upload_branch': 'Firefox', 18:04:45 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 18:04:45 INFO - 'branch': 'Firefox', 18:04:45 INFO - 'buildbot_json_path': 'buildprops.json', 18:04:45 INFO - 'code_coverage': False, 18:04:45 INFO - 'config_files': ('talos/linux_config.py',), 18:04:45 INFO - 'default_actions': ('clobber', 18:04:45 INFO - 'read-buildbot-config', 18:04:45 INFO - 'download-and-extract', 18:04:45 INFO - 'populate-webroot', 18:04:45 INFO - 'create-virtualenv', 18:04:45 INFO - 'install', 18:04:45 INFO - 'setup-mitmproxy', 18:04:45 INFO - 'run-tests'), 18:04:45 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 18:04:45 INFO - 'disable_ccov_upload': False, 18:04:45 INFO - 'download_minidump_stackwalk': True, 18:04:45 INFO - 'download_symbols': 'ondemand', 18:04:45 INFO - 'enable_stylo': False, 18:04:45 INFO - 'enable_webrender': False, 18:04:45 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 18:04:45 INFO - 'tooltool.py': '/tools/tooltool.py', 18:04:45 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 18:04:45 INFO - '/tools/misc-python/virtualenv.py')}, 18:04:45 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 18:04:45 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 18:04:45 INFO - 'gecko_profile': False, 18:04:45 INFO - 'gecko_profile_interval': 0, 18:04:45 INFO - 'installer_path': 'installer.exe', 18:04:45 INFO - 'log_level': 'info', 18:04:45 INFO - 'log_name': 'talos', 18:04:45 INFO - 'log_to_console': True, 18:04:45 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 18:04:45 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 18:04:45 INFO - 'opt_config_files': (), 18:04:45 INFO - 'pip_index': False, 18:04:45 INFO - 'suite': 'dromaeojs-e10s', 18:04:45 INFO - 'system_bits': '32', 18:04:45 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 18:04:45 INFO - 'title': 'talos-linux64-ix-045', 18:04:45 INFO - 'tooltool_cache': '/builds/tooltool_cache', 18:04:45 INFO - 'use_talos_json': True, 18:04:45 INFO - 'verify': 'False', 18:04:45 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 18:04:45 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 18:04:45 INFO - 'work_dir': 'build'} 18:04:45 INFO - [mozharness: 2017-08-23 01:04:45.216111Z] Running clobber step. 18:04:45 INFO - Running pre-action listener: _resource_record_pre_action 18:04:45 INFO - Running main action method: clobber 18:04:45 INFO - rmtree: /builds/slave/test/build 18:04:45 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 18:04:46 INFO - Running post-action listener: _resource_record_post_action 18:04:46 INFO - [mozharness: 2017-08-23 01:04:46.302920Z] Finished clobber step (success) 18:04:46 INFO - [mozharness: 2017-08-23 01:04:46.303018Z] Running read-buildbot-config step. 18:04:46 INFO - Running pre-action listener: _resource_record_pre_action 18:04:46 INFO - Running main action method: read_buildbot_config 18:04:46 INFO - Using buildbot properties: 18:04:46 INFO - { 18:04:46 INFO - "project": "", 18:04:46 INFO - "product": "firefox", 18:04:46 INFO - "who": "kwierso@gmail.com", 18:04:46 INFO - "installer_path": "public/build/target.tar.bz2", 18:04:46 INFO - "builddir": "mozilla-central_ubuntu64_hw_styloseq_test-dromaeojs-e10s", 18:04:46 INFO - "repository": "https://hg.mozilla.org/mozilla-central", 18:04:46 INFO - "buildername": "Ubuntu HW 12.04 x64 stylo-sequential mozilla-central talos dromaeojs-e10s", 18:04:46 INFO - "stage_platform": "linux64-stylosequential", 18:04:46 INFO - "basedir": "/builds/slave/test", 18:04:46 INFO - "buildnumber": 205, 18:04:46 INFO - "platform": "ubuntu64_hw_styloseq", 18:04:46 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 18:04:46 INFO - "slavebuilddir": "test", 18:04:46 INFO - "taskId": "EC6IdW4dTiSzYeOkuow0BA", 18:04:46 INFO - "branch": "mozilla-central", 18:04:46 INFO - "script_repo_revision": "production", 18:04:46 INFO - "revision": "64a45ee1731c79da9850233a797bf80d3b1a52bd", 18:04:46 INFO - "slavename": "talos-linux64-ix-045", 18:04:46 INFO - "repo_path": "mozilla-central" 18:04:46 INFO - } 18:04:46 INFO - Finding installer, test and symbols from parent task. 18:04:46 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/EC6IdW4dTiSzYeOkuow0BA'}, attempt #1 18:04:46 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/EC6IdW4dTiSzYeOkuow0BA'}, attempt #1 18:04:47 INFO - Task dependencies: IbzxS1zGRz6yU7eidXiiKg 18:04:47 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/IbzxS1zGRz6yU7eidXiiKg'}, attempt #1 18:04:47 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/IbzxS1zGRz6yU7eidXiiKg/artifacts/public/build/target.tar.bz2 18:04:47 INFO - Set test_packages_url: https://queue.taskcluster.net/v1/task/IbzxS1zGRz6yU7eidXiiKg/artifacts/public/build/target.test_packages.json 18:04:47 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/IbzxS1zGRz6yU7eidXiiKg/artifacts/public/build/target.crashreporter-symbols.zip 18:04:47 INFO - Running post-action listener: _resource_record_post_action 18:04:47 INFO - [mozharness: 2017-08-23 01:04:47.693178Z] Finished read-buildbot-config step (success) 18:04:47 INFO - [mozharness: 2017-08-23 01:04:47.693430Z] Running download-and-extract step. 18:04:47 INFO - Running pre-action listener: _resource_record_pre_action 18:04:47 INFO - Running main action method: download_and_extract 18:04:47 INFO - mkdir: /builds/slave/test/build/tests 18:04:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:04:47 INFO - trying https://queue.taskcluster.net/v1/task/IbzxS1zGRz6yU7eidXiiKg/artifacts/public/build/target.test_packages.json 18:04:47 INFO - Downloading https://queue.taskcluster.net/v1/task/IbzxS1zGRz6yU7eidXiiKg/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 18:04:47 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/IbzxS1zGRz6yU7eidXiiKg/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 18:04:48 INFO - Downloaded 989 bytes. 18:04:48 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 18:04:48 INFO - Using the following test package requirements: 18:04:48 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 18:04:48 INFO - u'common': [u'target.common.tests.zip'], 18:04:48 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 18:04:48 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 18:04:48 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 18:04:48 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 18:04:48 INFO - u'mozbase': [u'target.common.tests.zip'], 18:04:48 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 18:04:48 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 18:04:48 INFO - u'web-platform': [u'target.common.tests.zip', 18:04:48 INFO - u'target.web-platform.tests.tar.gz'], 18:04:48 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 18:04:48 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 18:04:48 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/IbzxS1zGRz6yU7eidXiiKg/artifacts/public/build/target.common.tests.zip 18:04:48 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/IbzxS1zGRz6yU7eidXiiKg/artifacts/public/build/target.common.tests.zip'}, attempt #1 18:04:48 INFO - Fetch https://queue.taskcluster.net/v1/task/IbzxS1zGRz6yU7eidXiiKg/artifacts/public/build/target.common.tests.zip into memory 18:04:49 INFO - Content-Length response header: 54949654 18:04:49 INFO - Bytes received: 54949654 18:05:00 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 18:05:00 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/IbzxS1zGRz6yU7eidXiiKg/artifacts/public/build/target.common.tests.zip 18:05:00 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/IbzxS1zGRz6yU7eidXiiKg/artifacts/public/build/target.common.tests.zip'}, attempt #1 18:05:00 INFO - Fetch https://queue.taskcluster.net/v1/task/IbzxS1zGRz6yU7eidXiiKg/artifacts/public/build/target.common.tests.zip into memory 18:05:01 INFO - Content-Length response header: 54949654 18:05:01 INFO - Bytes received: 54949654 18:05:13 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/IbzxS1zGRz6yU7eidXiiKg/artifacts/public/build/target.talos.tests.zip 18:05:13 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/IbzxS1zGRz6yU7eidXiiKg/artifacts/public/build/target.talos.tests.zip'}, attempt #1 18:05:13 INFO - Fetch https://queue.taskcluster.net/v1/task/IbzxS1zGRz6yU7eidXiiKg/artifacts/public/build/target.talos.tests.zip into memory 18:05:14 INFO - Content-Length response header: 14496256 18:05:14 INFO - Bytes received: 14496256 18:05:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:05:14 INFO - trying https://queue.taskcluster.net/v1/task/IbzxS1zGRz6yU7eidXiiKg/artifacts/public/build/target.tar.bz2 18:05:14 INFO - Downloading https://queue.taskcluster.net/v1/task/IbzxS1zGRz6yU7eidXiiKg/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 18:05:14 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/IbzxS1zGRz6yU7eidXiiKg/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 18:05:15 INFO - Downloaded 61179682 bytes. 18:05:15 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/IbzxS1zGRz6yU7eidXiiKg/artifacts/public/build/target.tar.bz2 18:05:15 INFO - mkdir: /builds/slave/test/properties 18:05:15 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 18:05:15 INFO - Writing to file /builds/slave/test/properties/build_url 18:05:15 INFO - Contents: 18:05:15 INFO - build_url:https://queue.taskcluster.net/v1/task/IbzxS1zGRz6yU7eidXiiKg/artifacts/public/build/target.tar.bz2 18:05:15 INFO - Running post-action listener: _resource_record_post_action 18:05:15 INFO - Running post-action listener: find_tests_for_verification 18:05:15 INFO - Running post-action listener: set_extra_try_arguments 18:05:15 INFO - [mozharness: 2017-08-23 01:05:15.545465Z] Finished download-and-extract step (success) 18:05:15 INFO - [mozharness: 2017-08-23 01:05:15.545574Z] Running populate-webroot step. 18:05:15 INFO - Running pre-action listener: _resource_record_pre_action 18:05:15 INFO - Running main action method: populate_webroot 18:05:15 INFO - {'suites': {'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 18:05:15 INFO - 'chromez-stylo-e10s': {'talos_options': ['--stylo'], 18:05:15 INFO - 'tests': ['tresize', 'tcanvasmark']}, 18:05:15 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 18:05:15 INFO - 'dromaeojs-stylo-e10s': {'talos_options': ['--stylo'], 18:05:15 INFO - 'tests': ['dromaeo_css', 'kraken']}, 18:05:15 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 18:05:15 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 18:05:15 INFO - 'g1-stylo-e10s': {'pagesets_name': 'tp5n.zip', 18:05:15 INFO - 'talos_options': ['--stylo'], 18:05:15 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 18:05:15 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 18:05:15 INFO - 'tests': ['damp', 'tps']}, 18:05:15 INFO - 'g2-stylo-e10s': {'pagesets_name': 'tp5n.zip', 18:05:15 INFO - 'talos_options': ['--stylo'], 18:05:15 INFO - 'tests': ['damp', 'tps']}, 18:05:15 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 18:05:15 INFO - 'g4-e10s': {'tests': ['basic_compositor_video', 'glvideo']}, 18:05:15 INFO - 'g4-stylo-e10s': {'talos_options': ['--stylo'], 18:05:15 INFO - 'tests': ['basic_compositor_video', 'glvideo']}, 18:05:15 INFO - 'g5-e10s': {'pagesets_name': 'tp5n.zip', 18:05:15 INFO - 'tests': ['ts_paint_webext', 'tp5o_webext']}, 18:05:15 INFO - 'g5-stylo-e10s': {'pagesets_name': 'tp5n.zip', 18:05:15 INFO - 'talos_options': ['--stylo'], 18:05:15 INFO - 'tests': ['ts_paint_webext', 'tp5o_webext']}, 18:05:15 INFO - 'other-e10s': {'tests': ['a11yr', 18:05:15 INFO - 'ts_paint', 18:05:15 INFO - 'tpaint', 18:05:15 INFO - 'sessionrestore', 18:05:15 INFO - 'sessionrestore_many_windows', 18:05:15 INFO - 'sessionrestore_no_auto_restore', 18:05:15 INFO - 'tabpaint']}, 18:05:15 INFO - 'other-stylo-e10s': {'talos_options': ['--stylo'], 18:05:15 INFO - 'tests': ['a11yr', 18:05:15 INFO - 'ts_paint', 18:05:15 INFO - 'tpaint', 18:05:15 INFO - 'sessionrestore', 18:05:15 INFO - 'sessionrestore_many_windows', 18:05:15 INFO - 'sessionrestore_no_auto_restore', 18:05:15 INFO - 'tabpaint']}, 18:05:15 INFO - 'perf-reftest-e10s': {'tests': ['bloom_basic']}, 18:05:15 INFO - 'perf-reftest-singletons-e10s': {'tests': ['bloom_basic_singleton']}, 18:05:15 INFO - 'perf-reftest-singletons-stylo-e10s': {'talos_options': ['--stylo'], 18:05:15 INFO - 'tests': ['bloom_basic_singleton']}, 18:05:15 INFO - 'perf-reftest-stylo-e10s': {'talos_options': ['--stylo'], 18:05:15 INFO - 'tests': ['bloom_basic']}, 18:05:15 INFO - 'svgr-e10s': {'tests': ['tsvgx', 18:05:15 INFO - 'tsvgr_opacity', 18:05:15 INFO - 'tart', 18:05:15 INFO - 'tscrollx', 18:05:15 INFO - 'tsvg_static']}, 18:05:15 INFO - 'svgr-stylo-e10s': {'talos_options': ['--stylo'], 18:05:15 INFO - 'tests': ['tsvgx', 18:05:15 INFO - 'tsvgr_opacity', 18:05:15 INFO - 'tart', 18:05:15 INFO - 'tscrollx', 18:05:15 INFO - 'tsvg_static']}, 18:05:15 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 18:05:15 INFO - 'tp5o-stylo-e10s': {'pagesets_name': 'tp5n.zip', 18:05:15 INFO - 'talos_options': ['--stylo'], 18:05:15 INFO - 'tests': ['tp5o']}, 18:05:15 INFO - 'tp6-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 18:05:15 INFO - 'talos_options': ['--mitmproxy', 18:05:15 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 18:05:15 INFO - '--firstNonBlankPaint'], 18:05:15 INFO - 'tests': ['tp6_google', 18:05:15 INFO - 'tp6_youtube', 18:05:15 INFO - 'tp6_amazon', 18:05:15 INFO - 'tp6_facebook']}, 18:05:15 INFO - 'tp6-stylo-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 18:05:15 INFO - 'talos_options': ['--stylo', 18:05:15 INFO - '--mitmproxy', 18:05:15 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 18:05:15 INFO - '--firstNonBlankPaint'], 18:05:15 INFO - 'tests': ['tp6_google', 18:05:15 INFO - 'tp6_youtube', 18:05:15 INFO - 'tp6_amazon', 18:05:15 INFO - 'tp6_facebook']}, 18:05:15 INFO - 'tp6-stylo-threads-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 18:05:15 INFO - 'talos_options': ['--stylo', 18:05:15 INFO - '--stylo-threads=1', 18:05:15 INFO - '--mitmproxy', 18:05:15 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 18:05:15 INFO - '--firstNonBlankPaint'], 18:05:15 INFO - 'tests': ['tp6_google', 18:05:15 INFO - 'tp6_youtube', 18:05:15 INFO - 'tp6_amazon', 18:05:15 INFO - 'tp6_facebook']}, 18:05:15 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 18:05:15 INFO - 'talos_options': ['--xperf_path', 18:05:15 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 18:05:15 INFO - 'tests': ['tp5n']}, 18:05:15 INFO - 'xperf-stylo-e10s': {'pagesets_name': 'tp5n.zip', 18:05:15 INFO - 'talos_options': ['--stylo', 18:05:15 INFO - '--xperf_path', 18:05:15 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 18:05:15 INFO - 'tests': ['tp5n']}}} 18:05:15 INFO - Running post-action listener: _resource_record_post_action 18:05:15 INFO - [mozharness: 2017-08-23 01:05:15.559722Z] Finished populate-webroot step (success) 18:05:15 INFO - [mozharness: 2017-08-23 01:05:15.559811Z] Running create-virtualenv step. 18:05:15 INFO - Running pre-action listener: _resource_record_pre_action 18:05:15 INFO - Running main action method: create_virtualenv 18:05:15 INFO - Creating virtualenv /builds/slave/test/build/venv 18:05:15 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 18:05:15 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 18:05:15 INFO - Using partial env: {'VIRTUALENV_NO_DOWNLOAD': '1'} 18:05:15 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 18:05:15 INFO - Using real prefix '/usr' 18:05:15 INFO - New python executable in /builds/slave/test/build/venv/bin/python 18:05:16 INFO - Installing distribute.............................................................................................................................................................................................done. 18:05:18 INFO - Installing pip.................done. 18:05:18 INFO - Return code: 0 18:05:18 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 18:05:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 18:05:18 INFO - Reading from file tmpfile_stdout 18:05:18 INFO - Output received: 18:05:18 INFO - pip 1.5.5 from /builds/slave/test/build/venv/local/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 18:05:18 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 18:05:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:05:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:05:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:05:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:05:18 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a571f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c22a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1dc5f90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dc3130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dc4030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1dc44c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1503450282.909478-95939596', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 18:05:18 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 18:05:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 18:05:18 INFO - Using env: {'DISPLAY': ':0', 18:05:18 INFO - 'HOME': '/home/cltbld', 18:05:18 INFO - 'LANG': 'en_US.UTF-8', 18:05:18 INFO - 'LANGUAGE': 'en_US:en', 18:05:18 INFO - 'LOGNAME': 'cltbld', 18:05:18 INFO - 'MAIL': '/var/mail/cltbld', 18:05:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:05:18 INFO - 'MOZ_NO_REMOTE': '1', 18:05:18 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:05:18 INFO - 'NO_EM_RESTART': '1', 18:05:18 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:05:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:05:18 INFO - 'PWD': '/builds/slave/test', 18:05:18 INFO - 'SHELL': '/bin/bash', 18:05:18 INFO - 'SHLVL': '1', 18:05:18 INFO - 'TERM': 'linux', 18:05:18 INFO - 'TMOUT': '86400', 18:05:18 INFO - 'USER': 'cltbld', 18:05:18 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1503450282.909478-95939596', 18:05:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:05:18 INFO - '_': '/tools/buildbot/bin/python'} 18:05:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:05:18 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 18:05:18 INFO - Cleaning up... 18:05:18 INFO - Return code: 0 18:05:18 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 18:05:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:05:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:05:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:05:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:05:18 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a571f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c22a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1dc5f90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dc3130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dc4030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1dc44c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1503450282.909478-95939596', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 18:05:18 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 18:05:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 18:05:18 INFO - Using env: {'DISPLAY': ':0', 18:05:18 INFO - 'HOME': '/home/cltbld', 18:05:18 INFO - 'LANG': 'en_US.UTF-8', 18:05:18 INFO - 'LANGUAGE': 'en_US:en', 18:05:18 INFO - 'LOGNAME': 'cltbld', 18:05:18 INFO - 'MAIL': '/var/mail/cltbld', 18:05:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:05:18 INFO - 'MOZ_NO_REMOTE': '1', 18:05:18 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:05:18 INFO - 'NO_EM_RESTART': '1', 18:05:18 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:05:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:05:18 INFO - 'PWD': '/builds/slave/test', 18:05:18 INFO - 'SHELL': '/bin/bash', 18:05:18 INFO - 'SHLVL': '1', 18:05:18 INFO - 'TERM': 'linux', 18:05:18 INFO - 'TMOUT': '86400', 18:05:18 INFO - 'USER': 'cltbld', 18:05:18 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1503450282.909478-95939596', 18:05:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:05:18 INFO - '_': '/tools/buildbot/bin/python'} 18:05:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:05:18 INFO - Downloading/unpacking psutil>=3.1.1 18:05:18 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:05:18 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:05:18 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:05:18 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:05:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 18:05:20 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 18:05:20 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 18:05:20 INFO - Installing collected packages: psutil 18:05:20 INFO - Running setup.py install for psutil 18:05:20 INFO - building 'psutil._psutil_linux' extension 18:05:20 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 18:05:20 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 18:05:20 INFO - building 'psutil._psutil_posix' extension 18:05:20 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 18:05:20 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 18:05:20 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 18:05:20 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 18:05:20 INFO - Successfully installed psutil 18:05:20 INFO - Cleaning up... 18:05:20 INFO - Return code: 0 18:05:20 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 18:05:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:05:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:05:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:05:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:05:20 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a571f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c22a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1dc5f90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dc3130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dc4030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1dc44c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1503450282.909478-95939596', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 18:05:20 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 18:05:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 18:05:20 INFO - Using env: {'DISPLAY': ':0', 18:05:20 INFO - 'HOME': '/home/cltbld', 18:05:20 INFO - 'LANG': 'en_US.UTF-8', 18:05:20 INFO - 'LANGUAGE': 'en_US:en', 18:05:20 INFO - 'LOGNAME': 'cltbld', 18:05:20 INFO - 'MAIL': '/var/mail/cltbld', 18:05:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:05:20 INFO - 'MOZ_NO_REMOTE': '1', 18:05:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:05:20 INFO - 'NO_EM_RESTART': '1', 18:05:20 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:05:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:05:20 INFO - 'PWD': '/builds/slave/test', 18:05:20 INFO - 'SHELL': '/bin/bash', 18:05:20 INFO - 'SHLVL': '1', 18:05:20 INFO - 'TERM': 'linux', 18:05:20 INFO - 'TMOUT': '86400', 18:05:20 INFO - 'USER': 'cltbld', 18:05:20 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1503450282.909478-95939596', 18:05:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:05:20 INFO - '_': '/tools/buildbot/bin/python'} 18:05:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:05:20 INFO - Downloading/unpacking mozsystemmonitor==0.3 18:05:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:05:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:05:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:05:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:05:21 INFO - Downloading mozsystemmonitor-0.3.tar.gz 18:05:21 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 18:05:21 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 18:05:21 INFO - Installing collected packages: mozsystemmonitor 18:05:21 INFO - Running setup.py install for mozsystemmonitor 18:05:22 INFO - Successfully installed mozsystemmonitor 18:05:22 INFO - Cleaning up... 18:05:22 INFO - Return code: 0 18:05:22 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 18:05:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:05:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:05:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:05:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:05:22 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a571f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c22a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1dc5f90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dc3130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dc4030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1dc44c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1503450282.909478-95939596', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 18:05:22 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 18:05:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 18:05:22 INFO - Using env: {'DISPLAY': ':0', 18:05:22 INFO - 'HOME': '/home/cltbld', 18:05:22 INFO - 'LANG': 'en_US.UTF-8', 18:05:22 INFO - 'LANGUAGE': 'en_US:en', 18:05:22 INFO - 'LOGNAME': 'cltbld', 18:05:22 INFO - 'MAIL': '/var/mail/cltbld', 18:05:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:05:22 INFO - 'MOZ_NO_REMOTE': '1', 18:05:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:05:22 INFO - 'NO_EM_RESTART': '1', 18:05:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:05:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:05:22 INFO - 'PWD': '/builds/slave/test', 18:05:22 INFO - 'SHELL': '/bin/bash', 18:05:22 INFO - 'SHLVL': '1', 18:05:22 INFO - 'TERM': 'linux', 18:05:22 INFO - 'TMOUT': '86400', 18:05:22 INFO - 'USER': 'cltbld', 18:05:22 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1503450282.909478-95939596', 18:05:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:05:22 INFO - '_': '/tools/buildbot/bin/python'} 18:05:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:05:22 INFO - Downloading/unpacking jsonschema==2.5.1 18:05:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:05:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:05:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:05:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:05:23 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 18:05:23 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 18:05:23 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:05:23 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:05:23 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:05:23 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:05:23 INFO - Downloading functools32-3.2.3-2.tar.gz 18:05:23 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 18:05:23 INFO - warning: no files found matching '*.txt' 18:05:23 INFO - no previously-included directories found matching 'build' 18:05:23 INFO - no previously-included directories found matching 'dist' 18:05:23 INFO - no previously-included directories found matching '.git*' 18:05:23 INFO - Installing collected packages: jsonschema, functools32 18:05:23 INFO - Running setup.py install for functools32 18:05:23 INFO - warning: no files found matching '*.txt' 18:05:23 INFO - no previously-included directories found matching 'build' 18:05:23 INFO - no previously-included directories found matching 'dist' 18:05:23 INFO - no previously-included directories found matching '.git*' 18:05:23 INFO - Successfully installed jsonschema functools32 18:05:23 INFO - Cleaning up... 18:05:23 INFO - Return code: 0 18:05:23 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 18:05:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:05:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:05:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:05:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:05:23 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a571f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c22a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1dc5f90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dc3130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dc4030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1dc44c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1503450282.909478-95939596', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 18:05:23 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 18:05:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 18:05:23 INFO - Using env: {'DISPLAY': ':0', 18:05:23 INFO - 'HOME': '/home/cltbld', 18:05:23 INFO - 'LANG': 'en_US.UTF-8', 18:05:23 INFO - 'LANGUAGE': 'en_US:en', 18:05:23 INFO - 'LOGNAME': 'cltbld', 18:05:23 INFO - 'MAIL': '/var/mail/cltbld', 18:05:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:05:23 INFO - 'MOZ_NO_REMOTE': '1', 18:05:23 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:05:23 INFO - 'NO_EM_RESTART': '1', 18:05:23 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:05:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:05:23 INFO - 'PWD': '/builds/slave/test', 18:05:23 INFO - 'SHELL': '/bin/bash', 18:05:23 INFO - 'SHLVL': '1', 18:05:23 INFO - 'TERM': 'linux', 18:05:23 INFO - 'TMOUT': '86400', 18:05:23 INFO - 'USER': 'cltbld', 18:05:23 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1503450282.909478-95939596', 18:05:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:05:23 INFO - '_': '/tools/buildbot/bin/python'} 18:05:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:05:23 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 18:05:23 INFO - Cleaning up... 18:05:23 INFO - Return code: 0 18:05:23 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 18:05:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:05:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:05:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:05:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:05:23 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a571f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c22a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1dc5f90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dc3130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dc4030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1dc44c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1503450282.909478-95939596', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 18:05:23 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 18:05:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 18:05:23 INFO - Using env: {'DISPLAY': ':0', 18:05:23 INFO - 'HOME': '/home/cltbld', 18:05:23 INFO - 'LANG': 'en_US.UTF-8', 18:05:23 INFO - 'LANGUAGE': 'en_US:en', 18:05:23 INFO - 'LOGNAME': 'cltbld', 18:05:23 INFO - 'MAIL': '/var/mail/cltbld', 18:05:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:05:23 INFO - 'MOZ_NO_REMOTE': '1', 18:05:23 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:05:23 INFO - 'NO_EM_RESTART': '1', 18:05:23 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:05:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:05:23 INFO - 'PWD': '/builds/slave/test', 18:05:23 INFO - 'SHELL': '/bin/bash', 18:05:23 INFO - 'SHLVL': '1', 18:05:23 INFO - 'TERM': 'linux', 18:05:23 INFO - 'TMOUT': '86400', 18:05:23 INFO - 'USER': 'cltbld', 18:05:23 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1503450282.909478-95939596', 18:05:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:05:23 INFO - '_': '/tools/buildbot/bin/python'} 18:05:24 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:05:24 INFO - Downloading/unpacking blobuploader==1.2.4 18:05:24 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:05:24 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:05:24 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:05:24 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:05:25 INFO - Downloading blobuploader-1.2.4.tar.gz 18:05:25 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 18:05:25 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 18:05:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:05:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:05:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:05:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:05:25 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 18:05:25 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 18:05:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:05:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:05:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:05:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:05:25 INFO - Downloading docopt-0.6.1.tar.gz 18:05:25 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 18:05:25 INFO - Installing collected packages: blobuploader, requests, docopt 18:05:25 INFO - Running setup.py install for blobuploader 18:05:25 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 18:05:25 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 18:05:25 INFO - Running setup.py install for requests 18:05:26 INFO - Running setup.py install for docopt 18:05:26 INFO - Successfully installed blobuploader requests docopt 18:05:26 INFO - Cleaning up... 18:05:26 INFO - Return code: 0 18:05:26 INFO - Installing None into virtualenv /builds/slave/test/build/venv 18:05:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:05:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:05:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:05:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:05:26 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a571f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c22a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1dc5f90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dc3130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dc4030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1dc44c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1503450282.909478-95939596', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 18:05:26 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 18:05:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 18:05:26 INFO - Using env: {'DISPLAY': ':0', 18:05:26 INFO - 'HOME': '/home/cltbld', 18:05:26 INFO - 'LANG': 'en_US.UTF-8', 18:05:26 INFO - 'LANGUAGE': 'en_US:en', 18:05:26 INFO - 'LOGNAME': 'cltbld', 18:05:26 INFO - 'MAIL': '/var/mail/cltbld', 18:05:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:05:26 INFO - 'MOZ_NO_REMOTE': '1', 18:05:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:05:26 INFO - 'NO_EM_RESTART': '1', 18:05:26 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:05:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:05:26 INFO - 'PWD': '/builds/slave/test', 18:05:26 INFO - 'SHELL': '/bin/bash', 18:05:26 INFO - 'SHLVL': '1', 18:05:26 INFO - 'TERM': 'linux', 18:05:26 INFO - 'TMOUT': '86400', 18:05:26 INFO - 'USER': 'cltbld', 18:05:26 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1503450282.909478-95939596', 18:05:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:05:26 INFO - '_': '/tools/buildbot/bin/python'} 18:05:26 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:05:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 18:05:26 INFO - Running setup.py (path:/tmp/pip-1ssA7m-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 18:05:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 18:05:26 INFO - Running setup.py (path:/tmp/pip-DOvYEy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 18:05:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 18:05:26 INFO - Running setup.py (path:/tmp/pip-E9YR5u-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 18:05:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 18:05:26 INFO - Running setup.py (path:/tmp/pip-AlNVBJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 18:05:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 18:05:26 INFO - Running setup.py (path:/tmp/pip-SogqdB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 18:05:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 18:05:27 INFO - Running setup.py (path:/tmp/pip-6KsOrY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 18:05:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 18:05:27 INFO - Running setup.py (path:/tmp/pip-B_XmCY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 18:05:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 18:05:27 INFO - Running setup.py (path:/tmp/pip-4Qicze-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 18:05:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 18:05:27 INFO - Running setup.py (path:/tmp/pip-UIzr2u-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 18:05:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 18:05:27 INFO - Running setup.py (path:/tmp/pip-2oIqki-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 18:05:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 18:05:27 INFO - Running setup.py (path:/tmp/pip-Dfymma-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 18:05:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 18:05:27 INFO - Running setup.py (path:/tmp/pip-Xqprpu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 18:05:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 18:05:27 INFO - Running setup.py (path:/tmp/pip-JerW2r-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 18:05:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 18:05:27 INFO - Running setup.py (path:/tmp/pip-Jr93Rg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 18:05:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 18:05:27 INFO - Running setup.py (path:/tmp/pip-5v_pUj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 18:05:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 18:05:27 INFO - Running setup.py (path:/tmp/pip-EKHu0j-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 18:05:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 18:05:27 INFO - Running setup.py (path:/tmp/pip-Zs61CP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 18:05:27 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 18:05:27 INFO - Running setup.py install for manifestparser 18:05:27 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 18:05:27 INFO - Running setup.py install for mozcrash 18:05:28 INFO - Running setup.py install for mozdebug 18:05:28 INFO - Running setup.py install for mozdevice 18:05:28 INFO - Installing dm script to /builds/slave/test/build/venv/bin 18:05:28 INFO - Running setup.py install for mozfile 18:05:28 INFO - Running setup.py install for mozhttpd 18:05:28 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 18:05:28 INFO - Running setup.py install for mozinfo 18:05:28 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 18:05:28 INFO - Running setup.py install for mozInstall 18:05:28 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 18:05:28 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 18:05:28 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 18:05:28 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 18:05:28 INFO - Running setup.py install for mozleak 18:05:28 INFO - Running setup.py install for mozlog 18:05:28 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 18:05:28 INFO - Running setup.py install for moznetwork 18:05:28 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 18:05:28 INFO - Running setup.py install for mozprocess 18:05:29 INFO - Running setup.py install for mozprofile 18:05:29 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 18:05:29 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 18:05:29 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 18:05:29 INFO - Running setup.py install for mozrunner 18:05:29 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 18:05:29 INFO - Running setup.py install for mozscreenshot 18:05:29 INFO - Running setup.py install for moztest 18:05:29 INFO - Running setup.py install for mozversion 18:05:29 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 18:05:29 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 18:05:29 INFO - Cleaning up... 18:05:29 INFO - Return code: 0 18:05:29 INFO - Installing None into virtualenv /builds/slave/test/build/venv 18:05:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:05:29 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:05:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:05:29 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:05:29 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a571f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c22a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1dc5f90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dc3130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dc4030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1dc44c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1503450282.909478-95939596', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 18:05:29 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 18:05:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 18:05:29 INFO - Using env: {'DISPLAY': ':0', 18:05:29 INFO - 'HOME': '/home/cltbld', 18:05:29 INFO - 'LANG': 'en_US.UTF-8', 18:05:29 INFO - 'LANGUAGE': 'en_US:en', 18:05:29 INFO - 'LOGNAME': 'cltbld', 18:05:29 INFO - 'MAIL': '/var/mail/cltbld', 18:05:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:05:29 INFO - 'MOZ_NO_REMOTE': '1', 18:05:29 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:05:29 INFO - 'NO_EM_RESTART': '1', 18:05:29 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:05:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:05:29 INFO - 'PWD': '/builds/slave/test', 18:05:29 INFO - 'SHELL': '/bin/bash', 18:05:29 INFO - 'SHLVL': '1', 18:05:29 INFO - 'TERM': 'linux', 18:05:29 INFO - 'TMOUT': '86400', 18:05:29 INFO - 'USER': 'cltbld', 18:05:29 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1503450282.909478-95939596', 18:05:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:05:29 INFO - '_': '/tools/buildbot/bin/python'} 18:05:29 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:05:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 18:05:29 INFO - Running setup.py (path:/tmp/pip-QEoC3H-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 18:05:29 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 18:05:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 18:05:29 INFO - Running setup.py (path:/tmp/pip-2a_qjQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 18:05:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 18:05:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 18:05:30 INFO - Running setup.py (path:/tmp/pip-tKxnie-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 18:05:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 18:05:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 18:05:30 INFO - Running setup.py (path:/tmp/pip-AWrXnH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 18:05:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.51 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 18:05:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 18:05:30 INFO - Running setup.py (path:/tmp/pip-pZiXQ3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 18:05:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 18:05:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 18:05:30 INFO - Running setup.py (path:/tmp/pip-yarJAd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 18:05:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 18:05:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 18:05:30 INFO - Running setup.py (path:/tmp/pip-7UsCnn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 18:05:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.10 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 18:05:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 18:05:30 INFO - Running setup.py (path:/tmp/pip-mSNTze-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 18:05:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.13 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 18:05:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 18:05:30 INFO - Running setup.py (path:/tmp/pip-qRjc2o-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 18:05:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 18:05:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 18:05:30 INFO - Running setup.py (path:/tmp/pip-CKVpN2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 18:05:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.5 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 18:05:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 18:05:30 INFO - Running setup.py (path:/tmp/pip-xVHfgn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 18:05:30 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 18:05:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 18:05:30 INFO - Running setup.py (path:/tmp/pip-_beZGV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 18:05:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.25 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 18:05:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 18:05:30 INFO - Running setup.py (path:/tmp/pip-YdYbJh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 18:05:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 18:05:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 18:05:30 INFO - Running setup.py (path:/tmp/pip-MuHapL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 18:05:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 18:05:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 18:05:30 INFO - Running setup.py (path:/tmp/pip-qF6v05-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 18:05:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 18:05:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 18:05:30 INFO - Running setup.py (path:/tmp/pip-yLFFYY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 18:05:31 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.8 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 18:05:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 18:05:31 INFO - Running setup.py (path:/tmp/pip-eI2BmW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 18:05:31 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 18:05:31 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 18:05:31 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 18:05:31 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 18:05:31 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.51->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 18:05:31 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.51->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 18:05:31 INFO - Requirement already satisfied (use --upgrade to upgrade): requests in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozInstall==1.13->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 18:05:31 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.5->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 18:05:31 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:05:31 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:05:31 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:05:31 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:05:32 INFO - Downloading blessings-1.6.tar.gz 18:05:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 18:05:32 INFO - Installing collected packages: blessings 18:05:32 INFO - Running setup.py install for blessings 18:05:32 INFO - Successfully installed blessings 18:05:32 INFO - Cleaning up... 18:05:32 INFO - Return code: 0 18:05:32 INFO - Done creating virtualenv /builds/slave/test/build/venv. 18:05:32 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 18:05:32 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 18:05:32 INFO - Reading from file tmpfile_stdout 18:05:32 INFO - Current package versions: 18:05:32 INFO - argparse == 1.2.1 18:05:32 INFO - blessings == 1.6 18:05:32 INFO - blobuploader == 1.2.4 18:05:32 INFO - docopt == 0.6.1 18:05:32 INFO - functools32 == 3.2.3-2 18:05:32 INFO - jsonschema == 2.5.1 18:05:32 INFO - manifestparser == 1.1 18:05:32 INFO - mozInstall == 1.13 18:05:32 INFO - mozcrash == 1.0 18:05:32 INFO - mozdebug == 0.1 18:05:32 INFO - mozdevice == 0.51 18:05:32 INFO - mozfile == 1.2 18:05:32 INFO - mozhttpd == 0.7 18:05:32 INFO - mozinfo == 0.10 18:05:32 INFO - mozleak == 0.1 18:05:32 INFO - mozlog == 3.5 18:05:32 INFO - moznetwork == 0.27 18:05:32 INFO - mozprocess == 0.25 18:05:32 INFO - mozprofile == 0.28 18:05:32 INFO - mozrunner == 6.13 18:05:32 INFO - mozscreenshot == 0.1 18:05:32 INFO - mozsystemmonitor == 0.3 18:05:32 INFO - moztest == 0.8 18:05:32 INFO - mozversion == 1.4 18:05:32 INFO - psutil == 3.1.1 18:05:32 INFO - requests == 1.2.3 18:05:32 INFO - wsgiref == 0.1.2 18:05:32 INFO - Installing None into virtualenv /builds/slave/test/build/venv 18:05:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:05:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:05:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:05:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:05:32 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a571f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c22a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1dc5f90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dc3130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dc4030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1dc44c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1503450282.909478-95939596', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 18:05:32 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 18:05:32 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 18:05:32 INFO - Using env: {'DISPLAY': ':0', 18:05:32 INFO - 'HOME': '/home/cltbld', 18:05:32 INFO - 'LANG': 'en_US.UTF-8', 18:05:32 INFO - 'LANGUAGE': 'en_US:en', 18:05:32 INFO - 'LOGNAME': 'cltbld', 18:05:32 INFO - 'MAIL': '/var/mail/cltbld', 18:05:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:05:32 INFO - 'MOZ_NO_REMOTE': '1', 18:05:32 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:05:32 INFO - 'NO_EM_RESTART': '1', 18:05:32 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:05:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:05:32 INFO - 'PWD': '/builds/slave/test', 18:05:32 INFO - 'SHELL': '/bin/bash', 18:05:32 INFO - 'SHLVL': '1', 18:05:32 INFO - 'TERM': 'linux', 18:05:32 INFO - 'TMOUT': '86400', 18:05:32 INFO - 'USER': 'cltbld', 18:05:32 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1503450282.909478-95939596', 18:05:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:05:32 INFO - '_': '/tools/buildbot/bin/python'} 18:05:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:05:32 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 18:05:32 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 18:05:32 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 18:05:32 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 18:05:32 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 18:05:32 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 18:05:32 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 18:05:32 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 18:05:32 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 18:05:32 INFO - Downloading/unpacking simplejson>=2.1.1 (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 10)) 18:05:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:05:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:05:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:05:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:05:33 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/simplejson/setup.py) egg_info for package simplejson 18:05:34 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 18:05:34 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 18:05:34 INFO - Installing collected packages: simplejson 18:05:34 INFO - Running setup.py install for simplejson 18:05:34 INFO - building 'simplejson._speedups' extension 18:05:34 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c simplejson/_speedups.c -o build/temp.linux-x86_64-2.7/simplejson/_speedups.o 18:05:34 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/simplejson/_speedups.o -o build/lib.linux-x86_64-2.7/simplejson/_speedups.so 18:05:35 INFO - Successfully installed simplejson 18:05:35 INFO - Cleaning up... 18:05:35 INFO - Return code: 0 18:05:35 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 18:05:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:05:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:05:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:05:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:05:35 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a571f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c22a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1dc5f90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dc3130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dc4030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1dc44c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1503450282.909478-95939596', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 18:05:35 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 18:05:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 18:05:35 INFO - Using env: {'DISPLAY': ':0', 18:05:35 INFO - 'HOME': '/home/cltbld', 18:05:35 INFO - 'LANG': 'en_US.UTF-8', 18:05:35 INFO - 'LANGUAGE': 'en_US:en', 18:05:35 INFO - 'LOGNAME': 'cltbld', 18:05:35 INFO - 'MAIL': '/var/mail/cltbld', 18:05:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:05:35 INFO - 'MOZ_NO_REMOTE': '1', 18:05:35 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:05:35 INFO - 'NO_EM_RESTART': '1', 18:05:35 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:05:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:05:35 INFO - 'PWD': '/builds/slave/test', 18:05:35 INFO - 'SHELL': '/bin/bash', 18:05:35 INFO - 'SHLVL': '1', 18:05:35 INFO - 'TERM': 'linux', 18:05:35 INFO - 'TMOUT': '86400', 18:05:35 INFO - 'USER': 'cltbld', 18:05:35 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1503450282.909478-95939596', 18:05:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:05:35 INFO - '_': '/tools/buildbot/bin/python'} 18:05:35 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:05:35 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 18:05:35 INFO - Cleaning up... 18:05:35 INFO - Return code: 0 18:05:35 INFO - Running post-action listener: _resource_record_post_action 18:05:35 INFO - Running post-action listener: _start_resource_monitoring 18:05:35 INFO - Starting resource monitoring. 18:05:35 INFO - [mozharness: 2017-08-23 01:05:35.372682Z] Finished create-virtualenv step (success) 18:05:35 INFO - [mozharness: 2017-08-23 01:05:35.373201Z] Running install step. 18:05:35 INFO - Running pre-action listener: _resource_record_pre_action 18:05:35 INFO - Running main action method: install 18:05:35 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 18:05:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 18:05:35 INFO - Reading from file tmpfile_stdout 18:05:35 INFO - Detecting whether we're running mozinstall >=1.0... 18:05:35 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 18:05:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 18:05:35 INFO - Reading from file tmpfile_stdout 18:05:35 INFO - Output received: 18:05:35 INFO - Usage: mozinstall [options] installer 18:05:35 INFO - Options: 18:05:35 INFO - -h, --help show this help message and exit 18:05:35 INFO - -d DEST, --destination=DEST 18:05:35 INFO - Directory to install application into. [default: 18:05:35 INFO - "/builds/slave/test"] 18:05:35 INFO - --app=APP Application being installed. [default: firefox] 18:05:35 INFO - mkdir: /builds/slave/test/build/application 18:05:35 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/target.tar.bz2', '--destination', '/builds/slave/test/build/application'] 18:05:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 18:05:53 INFO - Reading from file tmpfile_stdout 18:05:53 INFO - Output received: 18:05:53 INFO - /builds/slave/test/build/application/firefox/firefox 18:05:53 INFO - Running post-action listener: _resource_record_post_action 18:05:53 INFO - [mozharness: 2017-08-23 01:05:53.423555Z] Finished install step (success) 18:05:53 INFO - [mozharness: 2017-08-23 01:05:53.423896Z] Running setup-mitmproxy step. 18:05:53 INFO - Running pre-action listener: _resource_record_pre_action 18:05:53 INFO - Running main action method: setup_mitmproxy 18:05:53 INFO - Skipping: mitmproxy is not required 18:05:53 INFO - Running post-action listener: _resource_record_post_action 18:05:53 INFO - [mozharness: 2017-08-23 01:05:53.425551Z] Finished setup-mitmproxy step (success) 18:05:53 INFO - [mozharness: 2017-08-23 01:05:53.425892Z] Running run-tests step. 18:05:53 INFO - Running pre-action listener: _resource_record_pre_action 18:05:53 INFO - Running pre-action listener: _set_gcov_prefix 18:05:53 INFO - Running main action method: run_tests 18:05:53 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 18:05:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 18:05:53 INFO - Python 2.7.3 18:05:53 INFO - Return code: 0 18:05:53 INFO - grabbing minidump binary from tooltool 18:05:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:05:53 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dc3130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dc4030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1dc44c0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 18:05:53 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 18:05:53 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 18:05:53 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 18:05:53 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 18:05:53 INFO - Return code: 0 18:05:53 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 18:05:53 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 18:05:53 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 18:05:53 INFO - ENV: RUST_BACKTRACE is now full 18:05:53 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 18:05:53 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 18:05:53 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/IbzxS1zGRz6yU7eidXiiKg/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-045', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 18:05:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/IbzxS1zGRz6yU7eidXiiKg/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-045 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 18:05:53 INFO - Using env: {'DISPLAY': ':0', 18:05:53 INFO - 'HOME': '/home/cltbld', 18:05:53 INFO - 'LANG': 'en_US.UTF-8', 18:05:53 INFO - 'LANGUAGE': 'en_US:en', 18:05:53 INFO - 'LOGNAME': 'cltbld', 18:05:53 INFO - 'MAIL': '/var/mail/cltbld', 18:05:53 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 18:05:53 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 18:05:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:05:53 INFO - 'MOZ_NO_REMOTE': '1', 18:05:53 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 18:05:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:05:53 INFO - 'NO_EM_RESTART': '1', 18:05:53 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:05:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:05:53 INFO - 'PWD': '/builds/slave/test', 18:05:53 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 18:05:53 INFO - 'RUST_BACKTRACE': 'full', 18:05:53 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 18:05:53 INFO - 'SHELL': '/bin/bash', 18:05:53 INFO - 'SHLVL': '1', 18:05:53 INFO - 'STYLO_FORCE_ENABLED': '1', 18:05:53 INFO - 'TERM': 'linux', 18:05:53 INFO - 'TMOUT': '86400', 18:05:53 INFO - 'USER': 'cltbld', 18:05:53 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1503450282.909478-95939596', 18:05:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:05:53 INFO - '_': '/tools/buildbot/bin/python'} 18:05:53 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/IbzxS1zGRz6yU7eidXiiKg/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-045', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 18:05:53 INFO - mozversion application_buildid: 20170823000740 18:05:53 INFO - mozversion application_changeset: 64a45ee1731c79da9850233a797bf80d3b1a52bd 18:05:53 INFO - mozversion application_display_name: Nightly 18:05:53 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 18:05:53 INFO - mozversion application_name: Firefox 18:05:53 INFO - mozversion application_remotingname: firefox 18:05:53 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 18:05:53 INFO - mozversion application_vendor: Mozilla 18:05:53 INFO - mozversion application_version: 57.0a1 18:05:53 INFO - mozversion platform_buildid: 20170823000740 18:05:53 INFO - mozversion platform_changeset: 64a45ee1731c79da9850233a797bf80d3b1a52bd 18:05:53 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 18:05:53 INFO - mozversion platform_version: 57.0a1 18:05:53 INFO - using testdate: 1503450353 18:05:53 INFO - actual date: 1503450353 18:05:53 INFO - starting webserver on 'localhost:41651' 18:05:53 INFO - SUITE-START | Running 2 tests 18:05:53 INFO - TEST-START | dromaeo_css 18:05:53 INFO - Initialising browser for dromaeo_css test... 18:05:53 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:41651/getInfo.html -profile /tmp/tmpWXykLP/profile 18:05:53 INFO - TEST-INFO | started process 17814 (/builds/slave/test/build/application/firefox/firefox http://localhost:41651/getInfo.html) 18:05:59 INFO - TEST-INFO | 17814: exit 0 18:05:59 INFO - Browser initialized. 18:05:59 INFO - Running cycle 1/1 for dromaeo_css test... 18:05:59 INFO - TEST-INFO | started process 18000 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpWXykLP/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 18:06:00 INFO - PID 18000 | 18:06:00 INFO - PID 18000 | (/builds/slave/test/build/application/firefox/firefox:18050): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 18:06:00 INFO - PID 18000 | 18:06:01 INFO - PID 18000 | 18:06:01 INFO - PID 18000 | (/builds/slave/test/build/application/firefox/firefox:18110): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 18:06:01 INFO - PID 18000 | 18:06:01 INFO - PID 18000 | __metrics Screen width/height:1600/1200 18:06:01 INFO - PID 18000 | colorDepth:24 18:06:01 INFO - PID 18000 | Browser inner width/height: 1024/768 18:06:01 INFO - PID 18000 | __metrics 18:06:11 INFO - PID 18000 | RSS: Main: 174182400 18:06:11 INFO - PID 18000 | 18:07:04 INFO - PID 18000 | [Parent 18000] WARNING: pipe error (116): Connection reset by peer: file /home/worker/workspace/build/src/ipc/chromium/src/chrome/common/ipc_channel_posix.cc, line 353 18:09:10 INFO - PID 18000 | Cycle 1(1): loaded http://localhost:41651/tests/dromaeo/cssquery-dojo.html (next: http://localhost:41651/tests/dromaeo/cssquery-ext.html) 18:09:11 INFO - PID 18000 | RSS: Main: 178286592 18:09:11 INFO - PID 18000 | 18:12:13 INFO - PID 18000 | Cycle 1(1): loaded http://localhost:41651/tests/dromaeo/cssquery-ext.html (next: http://localhost:41651/tests/dromaeo/cssquery-jquery.html) 18:12:13 INFO - PID 18000 | RSS: Main: 174731264 18:12:13 INFO - PID 18000 | 18:15:15 INFO - PID 18000 | Cycle 1(1): loaded http://localhost:41651/tests/dromaeo/cssquery-jquery.html (next: http://localhost:41651/tests/dromaeo/cssquery-mootools.html) 18:15:16 INFO - PID 18000 | RSS: Main: 177504256 18:15:16 INFO - PID 18000 | 18:18:17 INFO - PID 18000 | Cycle 1(1): loaded http://localhost:41651/tests/dromaeo/cssquery-mootools.html (next: http://localhost:41651/tests/dromaeo/cssquery-prototype.html) 18:18:18 INFO - PID 18000 | RSS: Main: 175374336 18:18:18 INFO - PID 18000 | 18:21:22 INFO - PID 18000 | Cycle 1(1): loaded http://localhost:41651/tests/dromaeo/cssquery-prototype.html (next: http://localhost:41651/tests/dromaeo/cssquery-yui.html) 18:21:22 INFO - PID 18000 | RSS: Main: 178860032 18:21:22 INFO - PID 18000 | 18:24:24 INFO - PID 18000 | Cycle 1(1): loaded http://localhost:41651/tests/dromaeo/cssquery-yui.html (next: http://localhost:41651/tests/dromaeo/cssquery-dojo.html) 18:24:24 INFO - PID 18000 | RSS: Main: 180314112 18:24:24 INFO - PID 18000 | 18:24:24 INFO - PID 18000 | __start_tp_report 18:24:24 INFO - PID 18000 | _x_x_mozilla_page_load 18:24:24 INFO - PID 18000 | _x_x_mozilla_page_load_details 18:24:24 INFO - PID 18000 | |i|pagename|runs| 18:24:24 INFO - PID 18000 | |0;dojo.html;3212.437823380908;3267.1505408593775;3273.1162586101746;3286.293446908914;3290.144562413772;6121.173641558388;6149.446549810516;6159.445649891509;6185.752569897204;6194.349593292707;6182.103594978726;6292.653904035276;6297;6305.936940630592;6324.7470101195895;5686.914696279559;5747.683877386752;5764.423557644223;5784.595078344518;5796.188533605298;5608.775648974036;5657.688827114507;5704.286964129484;5732.111522713965;5736.2256095427;5597.132444471114;5620.016497113009;5646.350669672999;5653.886922261573;5658.632188907708;5649.943500565024;5659.094544872801;5743.655380677131;5758.654480731169;5782.3639399666;5617.101263797814;5770.394108618619;5772.942270577282;5779.826605201851;5796.88406231873;5968.283805943272;6059.818205453844;6133.44798968095;6198.566100372976;6208.72060757267;6604.93395066048;6631.535792494527;6699.196096468455;6713.899291510631;6721.563098398588;6708.262091169968;6718.83202919926;6754.5609535380045;6780.355866192704;6794.728210871609;6208.255009398856;6208.410201030895;6304.959681652567;6307.936920630781;6314.210723659543;6718.596884186964;6873.862522749617;6881.380675739208;6935.791926242221;6963.338482844122;6521.184851893513;6541.934580654228;6545.509086818508;6609.6695165241545;6634.104395906587;6644.136262285871;6694.029365742038;6715.328467153343;6715.865682686319;6761.492888033417;6558.508111891627;6600.636964966973;6684.331566843277;6702.631355275506;6727.058211850345;6496.7726129585235;6620.668966551653;6626.768063117768;6699.933000670028;6735.797926062226;5230.503102205284;5251.396089449762;5251.894962100737;5257.369115706139;5308.92036619451;4669.719816811003;4700.88247793801;4727.95272047282;4749.833755818529;4751.548602882721;5791.189233507313;5802.4197580241635;5806.68063256525;5887.1463637772285;5904.822855314347;6704.195496540447;6723.462123030145;6803.217629972518;6817.216020157745;6821.795346139624;5664.376918538957;5718.628289161191;5738.799142030009;5752.798652047159;5789.884202316014;5747.540196784247;5803.042497987869;5825.155352473867;5829.94170058294;5838.854028649318;6329.968350158312;6404.551681382259;6507.609543427409;6512.706928188148;6520.478361731145;6437.613743175424;6513.706883190173;6518.120053792677;6632.83417914556;6684.298148694512;6345.746170153327;6359.586626869239;6363.395477429637;6368.936310637019;6387.5209359297305;6555.573887697285;6565.179352580927;6577.3422657733845;6580.868382632416;6646.069550263063;6640.83397915056;6683.997400389786;6769.763058292936;6774.3225677431865;6774.93225067743;6433.388828061326;6443;6521.250056243593;6528.510361722985;6536.934630653823;6381.106645069787;6424.229092508929;6492.123563318892;6498.74005039812;6555.049517819794;6403.423691867754;6421.133147025092;6432.067350234283;6441;6449.806505804833;6436.324185960594;6518.185226846645;6526.641034742945;6565.638889861103;6571.474282057328;6098.451139397475;6138.324784273816;6190.783322583688;6267.122602835698;6330.651814150082 18:24:24 INFO - PID 18000 | |1;ext.html;805.5891495337377;818.1859050245007;841.7979684875629;867.3668222197791;867.8220964702234;38755.418668719954;39400.2119957601;39443.2111357773;39522.40716389257;39591.80204098976;36179.09552261195;36401.81799091001;36476;36499.81750091246;36884.81557592208;6844.31556844314;6920.619365934872;6947.444204463656;6971.895421568681;6994.265602111781;6820.488463365243;6939.791806245821;6940.618265995368;6941.861162776741;6944.583325000516;6898.896516552256;7548.131964824061;7670.731524396647;7678.0786305643405;7745.031871016123;7673.923260767405;7736.071671399468;7739.9613001935195;7746.186650401712;7749.806254843646;7432.219616940251;7614.086309642823;7616.428767842434;7616.504927179715;7618.162002179756;38120.618793811984;38545.421818672745;38575.42136867949;38604;38643.227135457135;3285.129440698217;3285.227971426713;3285.605727312714;3299.373119107362;3326.76712630116;30821.69178308233;30971;31037.22406939822;31043.379132417223;31342.686573134204;5090.974545127251;5092.26162206478;5116.462771409023;5127.410347810012;5142.151544995071;183906;184518;184541;185141;185786.07106964514;46286.305705414445;46316.536834631894;46362.76818615885;46382.30426543605;46384.5361546387;47935.80160496016;48527.27209091866;48574.27138592924;48593.514064859606;48603.5139648599;14365.497207597893;14657;14733.926330368495;14736.48422305214;14756.704865902837;11799.35103569312;11817.290962542274;11822.586209482626;11850.288982660895;11853.5851245206;13733.931330343285;13760.587182384545;13848.723025539633;13888.236147011808;14029.719405612035;5527.226188333637;5559.972200138974;5639.577031722637;5709.058005429058;5726.9713651431475;984.5372674842812;985.1035557642654;999.3004896572428;1000.3597697473623;1001.5493028137367;22173.33479995603;22258.554828903332;22309.661420314835;22412.66381004286;22527.848714886237;1099.4722533184117;1102.895224953628;1104.127739086113;1105.3975583307117;1119.261287550213;15487.922560387125;15550.300236489385;15617.375304987674;15959.202039897958;16079.517614471584;231282;232945;233046;233049;233402;52627.47372526302;55196.44803551913;55673.72163139239;56181.157282640794;56306.43693563012;1352.5991365326427;1376.3187222325014;1378.827646544182;1384.9723005540034;1420.2614640387148;26888.865555672095;27259.454810904066;27340.863295683394;27383.45233095287;27858;37782.62217377791;38144.23711525698;38163.42754858735;38164.236715266095;38215.426768597936;209749;211948;212320;212408;213043;33352.33295334128;34490.655093448746;34817;34938.65061349456;35325.470117947734;41946.790266048476;42147.3677894838;42455;42566.78716606521;42743;30792.384152317278;30793;30814;30880.691193087783;31595.84202078975;30588.235294117825;30811.691883080883;30853.537196942514;31084.844575776977;31728.524072138476;35286.29427411386;35335.29329413346;35612.46581301335;35661.1084722884;35699.64300357067;29143;29662.40675186441;29816.850915745283;29877.701222988362;30832;22562.661560076285;22607.773922260567;22741.545169096855;24040.39899002539;24994.625080623442 18:24:24 INFO - PID 18000 | |2;jquery.html;556.221290193729;557.6849080269648;559.6446256627042;567.8296511046688;576.7318197038377;21334.679979800298;22059.448513787163;22148.55702885943;22170.224042158527;22171.6674249886;22823.54352912941;23529.41176470585;25669.22992310229;25890.48219035623;25980.220593382182;7157.176924653666;7317.59753213573;7320.560766354036;7322.157951835554;7328.816779580527;6183.288921773986;6881.931180688204;7144.464165187605;7150.213476517605;7171.28287171284;6839.555428897131;6878.518503704742;6882.3461771131915;6885.277045910182;6885.414739747128;6746.561473504206;6829;6845.281245469228;6873.690683919235;6888.173419189729;6744.42672372844;6746.8313292167595;6753.966230168818;6760.188777346701;6770.763023294161;28546.857265713537;29181.70818291811;29318.41363172746;30027.249318766986;30711.38577228465;2114.0486780948636;2133.232036466871;2137.925172618951;2143.4427048967223;2152.5910077085305;19114.23543058276;19794.109265083105;19903.303384381477;19935.80064199354;19938.40184794444;2464.260721783458;2475.344033831036;2542.8474291542566;2586.094866796625;2593.8054645901443;133034.33482832622;138518.30740846333;138811.30594347065;138917.61082389147;138987;18912.15395914228;20508;20995.47511312199;21436.356909292746;21610;41423.7928810354;41439.58560414357;41450;41457.378139327935;41590.792046039576;11005.284656497302;11226.943865280622;11245.212835101627;11294.43527823622;11341.206115571997;9471.857922131036;9487.383320084173;9544.379615324982;9557.761055973517;9624.326297159132;10287.273872423664;10519.26365154432;10546.367217966947;11083.72290692723;11572.6528204154;3516.7889926604485;3527.4179760339257;3595.40675788492;3795.373763329075;4247.851325203603;914.9359544831798;944.3248077624531;956;964.2719746591418;964.4695417520336;19199.616007680048;19416.12627431769;19492.31776887802;19710.90144549268;20051.29820456277;1029.763154474475;1033.3696445168441;1042.1714736784274;1047.7537778622018;1049.9580016799243;10526.894731052591;10595.788084238273;10596.947015265028;10773.407462589475;10963.83554246671;535832;552401;553071;568172;568427;114662;115150.42424787823;117383.41308293404;122039;123427.68003119847;1154.7748189103213;1184.3367714080143;1197.239752756988;1201.3152503073165;1214.611324376191;16688.332466701682;17071.658566828843;17416.12919354002;17481.300747970447;17588.648227035643;52700.20949685835;53771.19343209777;55157.448425515235;55544.44455555393;56184.719076404355;69621.30378696148;71822.28177718156;72472.63763681147;73196.63401682957;73560.63219683868;11315.943420282845;11645.243059201124;13653.112547684368;13832.930835345758;14119.576412707635;21504.139834407073;21666.89166554157;21748.89125554362;21785.67321490147;21875.453113672287;17390.913045435198;17503;17574.20916058755;17891.28434862643;18068.457946261635;15979.760303595687;16158.919205403898;16364.590885227964;16415.343386264416;16600.50198494047;17837.108144592978;17972.640547188723;18235.179416926007;18331.266749329876;18420.07899605041;13835.10071845367;13838.4464621414;13911.513097041556;13939.442422302995;13946.860531394555;17459.56351091233;17613;17781.733274000642;17888;17943.192556335256 18:24:24 INFO - PID 18000 | |3;mootools.html;1303.876131767482;1339.2299427829;1366.0574203799383;1368.0560413314813;1389.034620938448;14356.928215358921;14924;14976.326065327059;14995.250237488122;15002.924985375084;14214.218217998006;15209.695806083872;15214.619634509143;15221.695566088672;15234.314455849486;2658.056389981558;2724.2916841621122;2724.387012922087;2726.6727992640913;2727.836329820207;2572.9228123156336;2630.289821748127;2661.7205193454697;2704.9459010819774;2729.331313828115;2696.0563802669008;2718.7009428962797;2724.278066312429;2753.8623068846578;2754.476649436601;2656.2031390582843;2668.239551727748;2700.9729902701015;2711.945761084767;2718.293243756618;2537.5939849624156;2575.5364034473787;2591.028364363364;2613.124603257911;2615.5422801009936;14520.128792272391;14677.045992010591;14678.486252981202;14681;14708;7854.332381747558;8171.387145964077;8177.223163799489;8179.345652347798;8180.7954801130445;5294.391145018334;5441.945580544223;5622.465865742748;5634;5638.210650508932;1819.5724004858848;1876.3432798520546;1885.58517126232;1922.8750131241563;1928.151613290148;25243.49513009748;25630.359241019123;25684.871575642377;25726.48547029049;25823.35441613956;7028.648567571601;7063.2583578724525;7077.82305442368;7314.3782778463365;7342.339189472973;19620.90189549043;19629.411117666492;19649.115789789495;19655.410337689893;19693.901530492254;7660.578668173304;7718.112417071996;7766.728164514215;7771.028621422322;7772.378209743207;6792.93207067923;6952.2352541220425;7091.574505529685;7093.574385536885;7187.820304492429;4607.470140933769;5122.590192784568;5295.311609490742;5352.678839269656;5405.918816236768;1425.4512012874911;1501.5570406730042;1522.6574020845442;1525.0620868165997;1526.198745658516;827.9213474719892;854.2269246332079;864.7059999600166;869.248100393168;885.022050634053;7748.4188685848785;7912.337274572959;7975.72084977023;8014.559199243981;8074;986.8963758805365;995.785906030207;999.0858364596313;1019.3781793106199;1021.7445638590352;4836.951630483721;5228.7908483660985;5257.894842103213;5285.55072818807;5486.683196032924;19608.607827843647;20170.89914550418;21036.894815525826;21255.256066037615;21256.149754009668;20813.1674733009;20995.160193592084;21070.367888963356;21153;21258.25596104129;10497.842532362021;10925.562977480971;11108.944455277671;11212.719682008015;11295;8161.591920403837;8237.217464340878;8318.209770071833;8420.031696354752;8503.107173746668;17525.123743813012;17778.199981000627;17859.28562857523;18008.099595019936;18050;18372.632547349247;18387.080645967915;18458.26166953307;18476.630467390307;18636.906815465834;11771.764564708828;11932.70168245766;11949;12088.637340879788;12089.57686480969;10930.726731831768;11324;13194.274314912773;13357.332133393096;13374.331283435984;10209.591616335561;10249.538770755185;10460.26778125524;10595.364278143028;10788.190885683449;9955.502224888582;10249.12882405004;10299.897001029894;10333.070023697903;10464.47677616101;9770.462624555717;10019;10023.198144148304;10024.047715467019;10026;7010.75462358815;7020.719171233298;7026.332498412643;7032.753853615099;7041.295870412918;7151.8569628608175;7157.320054594805;7195.424366050599;7210.206877243604;7265.745698900513 18:24:24 INFO - PID 18000 | |4;prototype.html;492.6108374384238;495.27552802922025;523.5000574451399;524.5410266017235;525.5296509623886;6114.205153330066;6142.662153581551;6142.710030893518;6173.969130154354;6184.907226391597;5810.709464526767;6046.8488287792825;6054.485368743662;6106.687062281609;6118.418750218733;4866;4887.2913427552985;4896.657233993622;4898.14282500561;4926.753662316888;4826.975865120669;4896.167651499236;4955.405351357842;4960.131976904046;4994.1260279451135;4919.926201106986;5026.949730502684;5093.388793344804;5113.156329205695;5113.6931784092885;5043.638217681242;5065.746712664352;5102.69383836971;5119.66722163062;5142.640015198937;4724.71651700899;4752.572268495852;4805.279208118775;4807.927881081787;4841.467438581753;6009.939900600982;6018.8495287617725;6078.726457309432;6102.847428814271;6122.28575998721;5828.154917536934;5901.8130209686715;5930.169776231331;5955.672438015908;5979.1629171915965;6508.446782023534;6540.4767618590395;6550.181227346582;6590.670466476657;6619.304972977864;5144;5175.560077393426;5186.377634683824;5196.700824793802;5205.141151710001;6715.832104197337;6718.883551681205;6853.9314606853795;6855.622940738307;6908.861822763567;5227.294315267391;5258.290130832365;5284.497972692588;5293.708846013506;5320.521153096162;5357.919631205535;5364.892702145935;5381.327334083239;5403.70279634616;5404.864878378072;5707.800226992118;5722.685252311163;5739.713014349266;5774.884502310014;5830.329512106077;6331.651759153198;6390.265119511223;6416.807495775134;6445.51658625605;6508.544401891917;1755.9824401756075;1783.5897743519063;1809.8461630761533;1815.4916623345484;1882.6611209982061;1375.3879523611897;1392.718698797109;1403.6280385697798;1414.6463384153963;1421.7085497472992;5533.280673512418;5547.472990065938;5555.8888822223325;5675.631083979528;5695.629784064023;6366.681665916778;6381.680915954184;6416.615003099829;6482.902756458657;6528.225504160712;5645.971770141123;5705.62913410627;5705.885882282331;5730.684812335278;5748.540116790647;3473.2879759649213;3484.581850177995;3491.738119641037;3515.5957064937347;3527.417976033977;6269.247690277196;6308.044506203092;6314;6321.026629834762;6437.742490300429;6677;6681.6302657955;6743.696533655997;6788.898166527506;6789.219239787488;6373.139626150411;6385;6446.871062578723;6467.514936379696;6474.611523308617;6491.221053473425;6549.181352330958;6578.8553211478375;6604;6669.2997235289595;6480.675966201766;6508.086394771917;6515.348465153446;6587.736490540325;6655.367740064686;6337.809865704036;6349.365063493614;6386.221993432871;6387.425131738166;6448.451881590117;4839.927401088916;4878.268259761065;4889.804407823647;4899.657024008286;4928.827491037797;6541.149650545399;6579.17760279965;6628.867422651617;6657.800265991834;6660;6080.543959202989;6242.719077641426;6258.311585725475;6261.279952805486;6277.587542803016;6253.09330147117;6261.405166509175;6271.62370257786;6325.703230837759;6407.455366293731;6195.938040619536;6235.532335074797;6264.655443950626;6382.234131904015;6389.55273130895;6174.924549797112;6358.979484744709;6381.649009304533;6412.39082287182;6578.144841170809;6066.1507388966465;6158.105690325539;6163.907541386972;6178.505719542336;6288.591241569284 18:24:24 INFO - PID 18000 | |5;yui.html;840.9537475438848;868.6481974800206;869.9434536755107;872.4808738800414;878.657323643779;18490.81509184908;19334.226630934765;19407.12667929943;19418.80581194186;20501.897490512525;20290.797092029075;20839.895800520975;20996.160153593875;21155.894220528913;21227.68158477624;881.7531091294431;909.2544113826632;909.790748127931;912.9315301352392;913;911.4759013567192;946.6781294359917;955.5652178258875;958.702802131338;959.4818797849153;990.1979396688669;1002.5187909803299;1002.5989604158322;1002.8495725641139;1002.8997100289986;999.6801023672427;1000.0149852395384;1000.6997900629782;1000.9199264058894;1001.4642166440956;727.4907564704675;727.803493056877;728.0644371981978;728.5774250934498;728.7012324946746;18820.905895470434;19130.617387652168;19231.903840480707;19320.32378866747;19341.12964916582;19496.122674479684;19576.119074641676;20205.595888082156;20527.281545145997;20593.07331170101;15505.457308994244;15997.20013999307;16019.91990040054;16087.517374478784;16214.351425942948;3574;3627.2020155565997;3630.455431685242;3630.80030598317;3632.4551317302353;127385;129904;131458;131638.6836131636;133136;15912.204389780465;16124.435644752612;16402.589935251715;16413.343466261456;16467;28117.43765124686;29062;30026.399472010875;30048.69951300459;30054.69945300519;8726.650933962697;8967.058458861726;8977.865332020025;9007.324450666227;9010.279177665901;4098.4876890388705;4206;4207.76857272853;4207.8316867325575;4211.136716973013;4751.3348131261655;4812.614990800727;4814.422269327633;4816.470188279286;4816.494268101869;951.0774548687762;957.2724729205714;970.737900766789;971.9659811906549;985.0543478260806;650.8470509430375;681.0533358631507;681.8465845184893;689.0663151429841;692.9549579277331;11427.314361138193;11789.465264968074;11812.350320732443;12099.57651482194;12567.93716031414;677.5900580149038;680.4182424027484;692.4806395203598;693.9132608423947;696.3489137656308;5668.603197776116;5763.740631671585;6144.692765361803;6192.318844927055;6370.394812492806;109977;113981.43009284901;115747;116876.41561792306;117682;95599;99257.02971881189;101883;103232;103487;88041.11958880458;88911.11088889158;89174.10825891657;90960.54519727359;91013;12134.575289864812;12149.696257593278;12262.20295680778;12424.316662583284;12546;39336.40995385129;39494.40758388684;39633;40555.1888962225;40699.59300406958;70956.64521677358;72023;72164.63917680379;72297;75299.62350188215;18777.812221878154;18804.811951880853;18930.14814333386;18953.71569426432;19198.424047278604;20886.582268354243;21038.263660772413;21186.576268474237;21233.36299911005;21385.89307053455;16307.673846523241;16966;17022.48932532026;17116.828831711522;17638.91180544089;17854;18120.18459169314;18399.908000459913;18406.447806565826;18604.534886627942;16463.91768041152;16645.50063498097;16925.746113808058;17012.149392530075;17063;13037.934810326267;13150.21098734079;13189.736205275649;13353.732925341244;13396.397162127532;14424.927875360556;14537.636559085684;14700.70598588001;14724.411023558938;14746.262686865828 18:24:24 INFO - PID 18000 | __end_tp_report 18:24:24 INFO - PID 18000 | __start_cc_report 18:24:24 INFO - PID 18000 | _x_x_mozilla_cycle_collect,378 18:24:24 INFO - PID 18000 | __end_cc_report 18:24:24 INFO - PID 18000 | __startTimestamp1503451464854__endTimestamp 18:24:24 INFO - PID 18000 | 18:24:24 INFO - PID 18000 | ------- Summary: start ------- 18:24:24 INFO - PID 18000 | Number of tests: 6 18:24:24 INFO - PID 18000 | 18:24:24 INFO - PID 18000 | [#0] dojo.html Cycles:165 Average:6134.85 Median:6359.59 stddev:707.99 (11.1%) stddev-sans-first:672.02 18:24:24 INFO - PID 18000 | Values: 3212.4 3267.2 3273.1 3286.3 3290.1 6121.2 6149.4 6159.4 6185.8 6194.3 6182.1 6292.7 6297.0 6305.9 6324.7 5686.9 5747.7 5764.4 5784.6 5796.2 5608.8 5657.7 5704.3 5732.1 5736.2 5597.1 5620.0 5646.4 5653.9 5658.6 5649.9 5659.1 5743.7 5758.7 5782.4 5617.1 5770.4 5772.9 5779.8 5796.9 5968.3 6059.8 6133.4 6198.6 6208.7 6604.9 6631.5 6699.2 6713.9 6721.6 6708.3 6718.8 6754.6 6780.4 6794.7 6208.3 6208.4 6305.0 6307.9 6314.2 6718.6 6873.9 6881.4 6935.8 6963.3 6521.2 6541.9 6545.5 6609.7 6634.1 6644.1 6694.0 6715.3 6715.9 6761.5 6558.5 6600.6 6684.3 6702.6 6727.1 6496.8 6620.7 6626.8 6699.9 6735.8 5230.5 5251.4 5251.9 5257.4 5308.9 4669.7 4700.9 4728.0 4749.8 4751.5 5791.2 5802.4 5806.7 5887.1 5904.8 6704.2 6723.5 6803.2 6817.2 6821.8 5664.4 5718.6 5738.8 5752.8 5789.9 5747.5 5803.0 5825.2 5829.9 5838.9 6330.0 6404.6 6507.6 6512.7 6520.5 6437.6 6513.7 6518.1 6632.8 6684.3 6345.7 6359.6 6363.4 6368.9 6387.5 6555.6 6565.2 6577.3 6580.9 6646.1 6640.8 6684.0 6769.8 6774.3 6774.9 6433.4 6443.0 6521.3 6528.5 6536.9 6381.1 6424.2 6492.1 6498.7 6555.0 6403.4 6421.1 6432.1 6441.0 6449.8 6436.3 6518.2 6526.6 6565.6 6571.5 6098.5 6138.3 6190.8 6267.1 6330.7 18:24:24 INFO - PID 18000 | 18:24:24 INFO - PID 18000 | [#1] ext.html Cycles:180 Average:37538.37 Median:35112.47 stddev:54620.46 (155.6%) stddev-sans-first:54704.04 18:24:24 INFO - PID 18000 | Values: 805.6 818.2 841.8 867.4 867.8 38755.4 39400.2 39443.2 39522.4 39591.8 36179.1 36401.8 36476.0 36499.8 36884.8 6844.3 6920.6 6947.4 6971.9 6994.3 6820.5 6939.8 6940.6 6941.9 6944.6 6898.9 7548.1 7670.7 7678.1 7745.0 7673.9 7736.1 7740.0 7746.2 7749.8 7432.2 7614.1 7616.4 7616.5 7618.2 38120.6 38545.4 38575.4 38604.0 38643.2 3285.1 3285.2 3285.6 3299.4 3326.8 30821.7 30971.0 31037.2 31043.4 31342.7 5091.0 5092.3 5116.5 5127.4 5142.2 183906.0 184518.0 184541.0 185141.0 185786.1 46286.3 46316.5 46362.8 46382.3 46384.5 47935.8 48527.3 48574.3 48593.5 48603.5 14365.5 14657.0 14733.9 14736.5 14756.7 11799.4 11817.3 11822.6 11850.3 11853.6 13733.9 13760.6 13848.7 13888.2 14029.7 5527.2 5560.0 5639.6 5709.1 5727.0 984.5 985.1 999.3 1000.4 1001.5 22173.3 22258.6 22309.7 22412.7 22527.8 1099.5 1102.9 1104.1 1105.4 1119.3 15487.9 15550.3 15617.4 15959.2 16079.5 231282.0 232945.0 233046.0 233049.0 233402.0 52627.5 55196.4 55673.7 56181.2 56306.4 1352.6 1376.3 1378.8 1385.0 1420.3 26888.9 27259.5 27340.9 27383.5 27858.0 37782.6 38144.2 38163.4 38164.2 38215.4 209749.0 211948.0 212320.0 212408.0 213043.0 33352.3 34490.7 34817.0 34938.7 35325.5 41946.8 42147.4 42455.0 42566.8 42743.0 30792.4 30793.0 30814.0 30880.7 31595.8 30588.2 30811.7 30853.5 31084.8 31728.5 35286.3 35335.3 35612.5 35661.1 35699.6 29143.0 29662.4 29816.9 29877.7 30832.0 22562.7 22607.8 22741.5 24040.4 24994.6 18:24:24 INFO - PID 18000 | 18:24:24 INFO - PID 18000 | [#2] jquery.html Cycles:180 Average:37252.33 Median:11881.30 stddev:92759.67 (780.7%) stddev-sans-first:92978.97 18:24:24 INFO - PID 18000 | Values: 556.2 557.7 559.6 567.8 576.7 21334.7 22059.4 22148.6 22170.2 22171.7 22823.5 23529.4 25669.2 25890.5 25980.2 7157.2 7317.6 7320.6 7322.2 7328.8 6183.3 6881.9 7144.5 7150.2 7171.3 6839.6 6878.5 6882.3 6885.3 6885.4 6746.6 6829.0 6845.3 6873.7 6888.2 6744.4 6746.8 6754.0 6760.2 6770.8 28546.9 29181.7 29318.4 30027.2 30711.4 2114.0 2133.2 2137.9 2143.4 2152.6 19114.2 19794.1 19903.3 19935.8 19938.4 2464.3 2475.3 2542.8 2586.1 2593.8 133034.3 138518.3 138811.3 138917.6 138987.0 18912.2 20508.0 20995.5 21436.4 21610.0 41423.8 41439.6 41450.0 41457.4 41590.8 11005.3 11226.9 11245.2 11294.4 11341.2 9471.9 9487.4 9544.4 9557.8 9624.3 10287.3 10519.3 10546.4 11083.7 11572.7 3516.8 3527.4 3595.4 3795.4 4247.9 914.9 944.3 956.0 964.3 964.5 19199.6 19416.1 19492.3 19710.9 20051.3 1029.8 1033.4 1042.2 1047.8 1050.0 10526.9 10595.8 10596.9 10773.4 10963.8 535832.0 552401.0 553071.0 568172.0 568427.0 114662.0 115150.4 117383.4 122039.0 123427.7 1154.8 1184.3 1197.2 1201.3 1214.6 16688.3 17071.7 17416.1 17481.3 17588.6 52700.2 53771.2 55157.4 55544.4 56184.7 69621.3 71822.3 72472.6 73196.6 73560.6 11315.9 11645.2 13653.1 13832.9 14119.6 21504.1 21666.9 21748.9 21785.7 21875.5 17390.9 17503.0 17574.2 17891.3 18068.5 15979.8 16158.9 16364.6 16415.3 16600.5 17837.1 17972.6 18235.2 18331.3 18420.1 13835.1 13838.4 13911.5 13939.4 13946.9 17459.6 17613.0 17781.7 17888.0 17943.2 18:24:24 INFO - PID 18000 | 18:24:24 INFO - PID 18000 | [#3] mootools.html Cycles:180 Average:9176.48 Median:14151.01 stddev:6530.89 (46.2%) stddev-sans-first:6522.42 18:24:24 INFO - PID 18000 | Values: 1303.9 1339.2 1366.1 1368.1 1389.0 14356.9 14924.0 14976.3 14995.3 15002.9 14214.2 15209.7 15214.6 15221.7 15234.3 2658.1 2724.3 2724.4 2726.7 2727.8 2572.9 2630.3 2661.7 2704.9 2729.3 2696.1 2718.7 2724.3 2753.9 2754.5 2656.2 2668.2 2701.0 2711.9 2718.3 2537.6 2575.5 2591.0 2613.1 2615.5 14520.1 14677.0 14678.5 14681.0 14708.0 7854.3 8171.4 8177.2 8179.3 8180.8 5294.4 5441.9 5622.5 5634.0 5638.2 1819.6 1876.3 1885.6 1922.9 1928.2 25243.5 25630.4 25684.9 25726.5 25823.4 7028.6 7063.3 7077.8 7314.4 7342.3 19620.9 19629.4 19649.1 19655.4 19693.9 7660.6 7718.1 7766.7 7771.0 7772.4 6792.9 6952.2 7091.6 7093.6 7187.8 4607.5 5122.6 5295.3 5352.7 5405.9 1425.5 1501.6 1522.7 1525.1 1526.2 827.9 854.2 864.7 869.2 885.0 7748.4 7912.3 7975.7 8014.6 8074.0 986.9 995.8 999.1 1019.4 1021.7 4837.0 5228.8 5257.9 5285.6 5486.7 19608.6 20170.9 21036.9 21255.3 21256.1 20813.2 20995.2 21070.4 21153.0 21258.3 10497.8 10925.6 11108.9 11212.7 11295.0 8161.6 8237.2 8318.2 8420.0 8503.1 17525.1 17778.2 17859.3 18008.1 18050.0 18372.6 18387.1 18458.3 18476.6 18636.9 11771.8 11932.7 11949.0 12088.6 12089.6 10930.7 11324.0 13194.3 13357.3 13374.3 10209.6 10249.5 10460.3 10595.4 10788.2 9955.5 10249.1 10299.9 10333.1 10464.5 9770.5 10019.0 10023.2 10024.0 10026.0 7010.8 7020.7 7026.3 7032.8 7041.3 7151.9 7157.3 7195.4 7210.2 7265.7 18:24:24 INFO - PID 18000 | 18:24:24 INFO - PID 18000 | [#4] prototype.html Cycles:180 Average:5476.50 Median:6072.44 stddev:1473.91 (24.3%) stddev-sans-first:1429.79 18:24:24 INFO - PID 18000 | Values: 492.6 495.3 523.5 524.5 525.5 6114.2 6142.7 6142.7 6174.0 6184.9 5810.7 6046.8 6054.5 6106.7 6118.4 4866.0 4887.3 4896.7 4898.1 4926.8 4827.0 4896.2 4955.4 4960.1 4994.1 4919.9 5026.9 5093.4 5113.2 5113.7 5043.6 5065.7 5102.7 5119.7 5142.6 4724.7 4752.6 4805.3 4807.9 4841.5 6009.9 6018.8 6078.7 6102.8 6122.3 5828.2 5901.8 5930.2 5955.7 5979.2 6508.4 6540.5 6550.2 6590.7 6619.3 5144.0 5175.6 5186.4 5196.7 5205.1 6715.8 6718.9 6853.9 6855.6 6908.9 5227.3 5258.3 5284.5 5293.7 5320.5 5357.9 5364.9 5381.3 5403.7 5404.9 5707.8 5722.7 5739.7 5774.9 5830.3 6331.7 6390.3 6416.8 6445.5 6508.5 1756.0 1783.6 1809.8 1815.5 1882.7 1375.4 1392.7 1403.6 1414.6 1421.7 5533.3 5547.5 5555.9 5675.6 5695.6 6366.7 6381.7 6416.6 6482.9 6528.2 5646.0 5705.6 5705.9 5730.7 5748.5 3473.3 3484.6 3491.7 3515.6 3527.4 6269.2 6308.0 6314.0 6321.0 6437.7 6677.0 6681.6 6743.7 6788.9 6789.2 6373.1 6385.0 6446.9 6467.5 6474.6 6491.2 6549.2 6578.9 6604.0 6669.3 6480.7 6508.1 6515.3 6587.7 6655.4 6337.8 6349.4 6386.2 6387.4 6448.5 4839.9 4878.3 4889.8 4899.7 4928.8 6541.1 6579.2 6628.9 6657.8 6660.0 6080.5 6242.7 6258.3 6261.3 6277.6 6253.1 6261.4 6271.6 6325.7 6407.5 6195.9 6235.5 6264.7 6382.2 6389.6 6174.9 6359.0 6381.6 6412.4 6578.1 6066.2 6158.1 6163.9 6178.5 6288.6 18:24:24 INFO - PID 18000 | 18:24:24 INFO - PID 18000 | [#5] yui.html Cycles:180 Average:24146.41 Median:21097.08 stddev:33377.93 (158.2%) stddev-sans-first:33425.69 18:24:24 INFO - PID 18000 | Values: 841.0 868.6 869.9 872.5 878.7 18490.8 19334.2 19407.1 19418.8 20501.9 20290.8 20839.9 20996.2 21155.9 21227.7 881.8 909.3 909.8 912.9 913.0 911.5 946.7 955.6 958.7 959.5 990.2 1002.5 1002.6 1002.8 1002.9 999.7 1000.0 1000.7 1000.9 1001.5 727.5 727.8 728.1 728.6 728.7 18820.9 19130.6 19231.9 19320.3 19341.1 19496.1 19576.1 20205.6 20527.3 20593.1 15505.5 15997.2 16019.9 16087.5 16214.4 3574.0 3627.2 3630.5 3630.8 3632.5 127385.0 129904.0 131458.0 131638.7 133136.0 15912.2 16124.4 16402.6 16413.3 16467.0 28117.4 29062.0 30026.4 30048.7 30054.7 8726.7 8967.1 8977.9 9007.3 9010.3 4098.5 4206.0 4207.8 4207.8 4211.1 4751.3 4812.6 4814.4 4816.5 4816.5 951.1 957.3 970.7 972.0 985.1 650.8 681.1 681.8 689.1 693.0 11427.3 11789.5 11812.4 12099.6 12567.9 677.6 680.4 692.5 693.9 696.3 5668.6 5763.7 6144.7 6192.3 6370.4 109977.0 113981.4 115747.0 116876.4 117682.0 95599.0 99257.0 101883.0 103232.0 103487.0 88041.1 88911.1 89174.1 90960.5 91013.0 12134.6 12149.7 12262.2 12424.3 12546.0 39336.4 39494.4 39633.0 40555.2 40699.6 70956.6 72023.0 72164.6 72297.0 75299.6 18777.8 18804.8 18930.1 18953.7 19198.4 20886.6 21038.3 21186.6 21233.4 21385.9 16307.7 16966.0 17022.5 17116.8 17638.9 17854.0 18120.2 18399.9 18406.4 18604.5 16463.9 16645.5 16925.7 17012.1 17063.0 13037.9 13150.2 13189.7 13353.7 13396.4 14424.9 14537.6 14700.7 14724.4 14746.3 18:24:24 INFO - PID 18000 | -------- Summary: end -------- 18:24:24 INFO - PID 18000 | 18:24:25 INFO - PID 18000 | [Parent 18000] WARNING: pipe error (60): Connection reset by peer: file /home/worker/workspace/build/src/ipc/chromium/src/chrome/common/ipc_channel_posix.cc, line 353 18:24:25 INFO - TEST-INFO | 18000: exit 0 18:24:25 INFO - TEST-OK | dromaeo_css | took 1111851ms 18:24:25 INFO - TEST-START | kraken 18:24:25 INFO - Initialising browser for kraken test... 18:24:25 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:41651/getInfo.html -profile /tmp/tmpR6aUj9/profile 18:24:25 INFO - TEST-INFO | started process 18428 (/builds/slave/test/build/application/firefox/firefox http://localhost:41651/getInfo.html) 18:24:31 INFO - TEST-INFO | 18428: exit 0 18:24:31 INFO - Browser initialized. 18:24:31 INFO - Running cycle 1/1 for kraken test... 18:24:31 INFO - TEST-INFO | started process 18617 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpR6aUj9/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 18:24:32 INFO - PID 18617 | 18:24:32 INFO - PID 18617 | (/builds/slave/test/build/application/firefox/firefox:18666): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 18:24:32 INFO - PID 18617 | 18:24:33 INFO - PID 18617 | 18:24:33 INFO - PID 18617 | (/builds/slave/test/build/application/firefox/firefox:18726): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 18:24:33 INFO - PID 18617 | 18:24:33 INFO - PID 18617 | __metrics Screen width/height:1600/1200 18:24:33 INFO - PID 18617 | colorDepth:24 18:24:33 INFO - PID 18617 | Browser inner width/height: 1024/768 18:24:33 INFO - PID 18617 | __metrics 18:24:42 INFO - PID 18617 | RSS: Main: 174477312 18:24:42 INFO - PID 18617 | 18:24:45 INFO - PID 18617 | Cycle 1(1): loaded http://localhost:41651/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:41651/tests/kraken/driver.html?testName=audio-beat-detection) 18:24:46 INFO - PID 18617 | RSS: Main: 178429952 18:24:46 INFO - PID 18617 | 18:24:49 INFO - PID 18617 | Cycle 1(1): loaded http://localhost:41651/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:41651/tests/kraken/driver.html?testName=audio-dft) 18:24:49 INFO - PID 18617 | RSS: Main: 180518912 18:24:49 INFO - PID 18617 | 18:24:53 INFO - PID 18617 | Cycle 1(1): loaded http://localhost:41651/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:41651/tests/kraken/driver.html?testName=audio-fft) 18:24:53 INFO - PID 18617 | RSS: Main: 175071232 18:24:53 INFO - PID 18617 | 18:24:55 INFO - PID 18617 | Cycle 1(1): loaded http://localhost:41651/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:41651/tests/kraken/driver.html?testName=audio-oscillator) 18:24:56 INFO - PID 18617 | RSS: Main: 175161344 18:24:56 INFO - PID 18617 | 18:24:58 INFO - PID 18617 | Cycle 1(1): loaded http://localhost:41651/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:41651/tests/kraken/driver.html?testName=imaging-gaussian-blur) 18:24:59 INFO - PID 18617 | RSS: Main: 175181824 18:24:59 INFO - PID 18617 | 18:25:02 INFO - PID 18617 | Cycle 1(1): loaded http://localhost:41651/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:41651/tests/kraken/driver.html?testName=imaging-darkroom) 18:25:03 INFO - PID 18617 | RSS: Main: 176545792 18:25:03 INFO - PID 18617 | 18:25:06 INFO - PID 18617 | Cycle 1(1): loaded http://localhost:41651/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:41651/tests/kraken/driver.html?testName=imaging-desaturate) 18:25:07 INFO - PID 18617 | RSS: Main: 176164864 18:25:07 INFO - PID 18617 | 18:25:10 INFO - PID 18617 | Cycle 1(1): loaded http://localhost:41651/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:41651/tests/kraken/driver.html?testName=json-parse-financial) 18:25:10 INFO - PID 18617 | RSS: Main: 177631232 18:25:10 INFO - PID 18617 | 18:25:12 INFO - PID 18617 | Cycle 1(1): loaded http://localhost:41651/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:41651/tests/kraken/driver.html?testName=json-stringify-tinderbox) 18:25:13 INFO - PID 18617 | RSS: Main: 177385472 18:25:13 INFO - PID 18617 | 18:25:15 INFO - PID 18617 | Cycle 1(1): loaded http://localhost:41651/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:41651/tests/kraken/driver.html?testName=stanford-crypto-aes) 18:25:15 INFO - PID 18617 | RSS: Main: 177221632 18:25:15 INFO - PID 18617 | 18:25:17 INFO - PID 18617 | Cycle 1(1): loaded http://localhost:41651/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:41651/tests/kraken/driver.html?testName=stanford-crypto-ccm) 18:25:18 INFO - PID 18617 | RSS: Main: 177410048 18:25:18 INFO - PID 18617 | 18:25:21 INFO - PID 18617 | Cycle 1(1): loaded http://localhost:41651/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:41651/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 18:25:21 INFO - PID 18617 | RSS: Main: 177557504 18:25:21 INFO - PID 18617 | 18:25:24 INFO - PID 18617 | Cycle 1(1): loaded http://localhost:41651/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:41651/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 18:25:25 INFO - PID 18617 | RSS: Main: 177479680 18:25:25 INFO - PID 18617 | 18:25:27 INFO - PID 18617 | Cycle 1(1): loaded http://localhost:41651/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:41651/tests/kraken/driver.html?testName=ai-astar) 18:25:27 INFO - PID 18617 | RSS: Main: 179380224 18:25:27 INFO - PID 18617 | 18:25:27 INFO - PID 18617 | __start_tp_report 18:25:27 INFO - PID 18617 | _x_x_mozilla_page_load 18:25:27 INFO - PID 18617 | _x_x_mozilla_page_load_details 18:25:27 INFO - PID 18617 | |i|pagename|runs| 18:25:27 INFO - PID 18617 | |0;ai-astar;99;110;106;107;109;114;110;101;107;107 18:25:27 INFO - PID 18617 | |1;audio-beat-detection;148;118;153;176;123;150;152;118;178;123 18:25:27 INFO - PID 18617 | |2;audio-dft;164;164;164;161;168;163;179;161;167;163 18:25:27 INFO - PID 18617 | |3;audio-fft;74;73;74;177;77;73;73;93;96;75 18:25:27 INFO - PID 18617 | |4;audio-oscillator;85;79;128;78;78;78;124;78;80;129 18:25:27 INFO - PID 18617 | |5;imaging-gaussian-blur;113;113;118;114;114;114;117;118;118;118 18:25:27 INFO - PID 18617 | |6;imaging-darkroom;148;147;148;148;150;149;148;147;151;149 18:25:27 INFO - PID 18617 | |7;imaging-desaturate;94;93;94;94;97;94;94;93;93;94 18:25:27 INFO - PID 18617 | |8;json-parse-financial;51;53;55;61;57;53;53;50;52;55 18:25:27 INFO - PID 18617 | |9;json-stringify-tinderbox;55;54;54;55;59;55;55;56;54;55 18:25:27 INFO - PID 18617 | |10;stanford-crypto-aes;75;84;75;73;74;73;73;73;73;77 18:25:27 INFO - PID 18617 | |11;stanford-crypto-ccm;126;121;118;118;115;122;121;119;117;167 18:25:27 INFO - PID 18617 | |12;stanford-crypto-pbkdf2;177;171;171;167;169;172;177;167;167;184 18:25:27 INFO - PID 18617 | |13;stanford-crypto-sha256-iterative;71;63;64;71;63;65;65;66;64;62 18:25:27 INFO - PID 18617 | __end_tp_report 18:25:27 INFO - PID 18617 | __start_cc_report 18:25:27 INFO - PID 18617 | _x_x_mozilla_cycle_collect,977 18:25:27 INFO - PID 18617 | __end_cc_report 18:25:27 INFO - PID 18617 | __startTimestamp1503451527612__endTimestamp 18:25:27 INFO - PID 18617 | 18:25:27 INFO - PID 18617 | ------- Summary: start ------- 18:25:27 INFO - PID 18617 | Number of tests: 14 18:25:27 INFO - PID 18617 | 18:25:27 INFO - PID 18617 | [#0] ai-astar Cycles:10 Average:107.00 Median:109.50 stddev:4.37 (4.0%) stddev-sans-first:3.55 18:25:27 INFO - PID 18617 | Values: 99.0 110.0 106.0 107.0 109.0 114.0 110.0 101.0 107.0 107.0 18:25:27 INFO - PID 18617 | 18:25:27 INFO - PID 18617 | [#1] audio-beat-detection Cycles:10 Average:143.90 Median:151.00 stddev:22.63 (15.0%) stddev-sans-first:23.96 18:25:27 INFO - PID 18617 | Values: 148.0 118.0 153.0 176.0 123.0 150.0 152.0 118.0 178.0 123.0 18:25:27 INFO - PID 18617 | 18:25:27 INFO - PID 18617 | [#2] audio-dft Cycles:10 Average:165.40 Median:164.00 stddev:5.27 (3.2%) stddev-sans-first:5.57 18:25:27 INFO - PID 18617 | Values: 164.0 164.0 164.0 161.0 168.0 163.0 179.0 161.0 167.0 163.0 18:25:27 INFO - PID 18617 | 18:25:27 INFO - PID 18617 | [#3] audio-fft Cycles:10 Average:88.50 Median:74.50 stddev:32.26 (43.3%) stddev-sans-first:33.78 18:25:27 INFO - PID 18617 | Values: 74.0 73.0 74.0 177.0 77.0 73.0 73.0 93.0 96.0 75.0 18:25:27 INFO - PID 18617 | 18:25:27 INFO - PID 18617 | [#4] audio-oscillator Cycles:10 Average:93.70 Median:78.00 stddev:23.11 (29.6%) stddev-sans-first:24.30 18:25:27 INFO - PID 18617 | Values: 85.0 79.0 128.0 78.0 78.0 78.0 124.0 78.0 80.0 129.0 18:25:27 INFO - PID 18617 | 18:25:27 INFO - PID 18617 | [#5] imaging-gaussian-blur Cycles:10 Average:115.70 Median:117.50 stddev:2.26 (1.9%) stddev-sans-first:2.18 18:25:27 INFO - PID 18617 | Values: 113.0 113.0 118.0 114.0 114.0 114.0 117.0 118.0 118.0 118.0 18:25:27 INFO - PID 18617 | 18:25:27 INFO - PID 18617 | [#6] imaging-darkroom Cycles:10 Average:148.50 Median:148.50 stddev:1.27 (0.9%) stddev-sans-first:1.33 18:25:27 INFO - PID 18617 | Values: 148.0 147.0 148.0 148.0 150.0 149.0 148.0 147.0 151.0 149.0 18:25:27 INFO - PID 18617 | 18:25:27 INFO - PID 18617 | [#7] imaging-desaturate Cycles:10 Average:94.00 Median:94.00 stddev:1.15 (1.2%) stddev-sans-first:1.22 18:25:27 INFO - PID 18617 | Values: 94.0 93.0 94.0 94.0 97.0 94.0 94.0 93.0 93.0 94.0 18:25:27 INFO - PID 18617 | 18:25:27 INFO - PID 18617 | [#8] json-parse-financial Cycles:10 Average:54.00 Median:54.00 stddev:3.20 (5.9%) stddev-sans-first:3.20 18:25:27 INFO - PID 18617 | Values: 51.0 53.0 55.0 61.0 57.0 53.0 53.0 50.0 52.0 55.0 18:25:27 INFO - PID 18617 | 18:25:27 INFO - PID 18617 | [#9] json-stringify-tinderbox Cycles:10 Average:55.20 Median:55.00 stddev:1.48 (2.7%) stddev-sans-first:1.56 18:25:27 INFO - PID 18617 | Values: 55.0 54.0 54.0 55.0 59.0 55.0 55.0 56.0 54.0 55.0 18:25:27 INFO - PID 18617 | 18:25:27 INFO - PID 18617 | [#10] stanford-crypto-aes Cycles:10 Average:75.00 Median:74.50 stddev:3.43 (4.6%) stddev-sans-first:3.64 18:25:27 INFO - PID 18617 | Values: 75.0 84.0 75.0 73.0 74.0 73.0 73.0 73.0 73.0 77.0 18:25:27 INFO - PID 18617 | 18:25:27 INFO - PID 18617 | [#11] stanford-crypto-ccm Cycles:10 Average:124.40 Median:121.00 stddev:15.28 (12.6%) stddev-sans-first:16.19 18:25:27 INFO - PID 18617 | Values: 126.0 121.0 118.0 118.0 115.0 122.0 121.0 119.0 117.0 167.0 18:25:27 INFO - PID 18617 | 18:25:27 INFO - PID 18617 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:172.20 Median:171.50 stddev:5.57 (3.2%) stddev-sans-first:5.63 18:25:27 INFO - PID 18617 | Values: 177.0 171.0 171.0 167.0 169.0 172.0 177.0 167.0 167.0 184.0 18:25:27 INFO - PID 18617 | 18:25:27 INFO - PID 18617 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:65.40 Median:65.00 stddev:3.17 (4.9%) stddev-sans-first:2.64 18:25:27 INFO - PID 18617 | Values: 71.0 63.0 64.0 71.0 63.0 65.0 65.0 66.0 64.0 62.0 18:25:27 INFO - PID 18617 | -------- Summary: end -------- 18:25:27 INFO - PID 18617 | 18:25:27 INFO - PID 18617 | 18:25:27 INFO - PID 18617 | ###!!! [Parent][MessageChannel] Error: (msgtype=0x150079,name=PBrowser::Msg_Destroy) Closed channel: cannot send/recv 18:25:27 INFO - PID 18617 | 18:25:27 INFO - PID 18617 | 18:25:27 INFO - PID 18617 | ###!!! [Child][MessageChannel] Error: (msgtype=0x150001,name=PBrowser::Msg_AsyncMessage) Closed channel: cannot send/recv 18:25:27 INFO - PID 18617 | 18:25:28 INFO - PID 18617 | *** UTM:SVC TimerManager:registerTimer called after profile-before-change notification. Ignoring timer registration for id: telemetry_modules_ping 18:25:28 INFO - TEST-INFO | 18617: exit 0 18:25:28 INFO - TEST-OK | kraken | took 62708ms 18:25:28 INFO - SUITE-END | took 1174s 18:25:28 INFO - Completed test suite (00:19:34) 18:25:28 INFO - javascript benchmark 18:25:28 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 8535.762165564684, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3212.437823380908, 3267.1505408593775, 3273.1162586101746, 3286.293446908914, 3290.144562413772, 6121.173641558388, 6149.446549810516, 6159.445649891509, 6185.752569897204, 6194.349593292707, 6182.103594978726, 6292.653904035276, 6297.0, 6305.936940630592, 6324.7470101195895, 5686.914696279559, 5747.683877386752, 5764.423557644223, 5784.595078344518, 5796.188533605298, 5608.775648974036, 5657.688827114507, 5704.286964129484, 5732.111522713965, 5736.2256095427, 5597.132444471114, 5620.016497113009, 5646.350669672999, 5653.886922261573, 5658.632188907708, 5649.943500565024, 5659.094544872801, 5743.655380677131, 5758.654480731169, 5782.3639399666, 5617.101263797814, 5770.394108618619, 5772.942270577282, 5779.826605201851, 5796.88406231873, 5968.283805943272, 6059.818205453844, 6133.44798968095, 6198.566100372976, 6208.72060757267, 6604.93395066048, 6631.535792494527, 6699.196096468455, 6713.899291510631, 6721.563098398588, 6708.262091169968, 6718.83202919926, 6754.5609535380045, 6780.355866192704, 6794.728210871609, 6208.255009398856, 6208.410201030895, 6304.959681652567, 6307.936920630781, 6314.210723659543, 6718.596884186964, 6873.862522749617, 6881.380675739208, 6935.791926242221, 6963.338482844122, 6521.184851893513, 6541.934580654228, 6545.509086818508, 6609.6695165241545, 6634.104395906587, 6644.136262285871, 6694.029365742038, 6715.328467153343, 6715.865682686319, 6761.492888033417, 6558.508111891627, 6600.636964966973, 6684.331566843277, 6702.631355275506, 6727.058211850345, 6496.7726129585235, 6620.668966551653, 6626.768063117768, 6699.933000670028, 6735.797926062226, 5230.503102205284, 5251.396089449762, 5251.894962100737, 5257.369115706139, 5308.92036619451, 4669.719816811003, 4700.88247793801, 4727.95272047282, 4749.833755818529, 4751.548602882721, 5791.189233507313, 5802.4197580241635, 5806.68063256525, 5887.1463637772285, 5904.822855314347, 6704.195496540447, 6723.462123030145, 6803.217629972518, 6817.216020157745, 6821.795346139624, 5664.376918538957, 5718.628289161191, 5738.799142030009, 5752.798652047159, 5789.884202316014, 5747.540196784247, 5803.042497987869, 5825.155352473867, 5829.94170058294, 5838.854028649318, 6329.968350158312, 6404.551681382259, 6507.609543427409, 6512.706928188148, 6520.478361731145, 6437.613743175424, 6513.706883190173, 6518.120053792677, 6632.83417914556, 6684.298148694512, 6345.746170153327, 6359.586626869239, 6363.395477429637, 6368.936310637019, 6387.5209359297305, 6555.573887697285, 6565.179352580927, 6577.3422657733845, 6580.868382632416, 6646.069550263063, 6640.83397915056, 6683.997400389786, 6769.763058292936, 6774.3225677431865, 6774.93225067743, 6433.388828061326, 6443.0, 6521.250056243593, 6528.510361722985, 6536.934630653823, 6381.106645069787, 6424.229092508929, 6492.123563318892, 6498.74005039812, 6555.049517819794, 6403.423691867754, 6421.133147025092, 6432.067350234283, 6441.0, 6449.806505804833, 6436.324185960594, 6518.185226846645, 6526.641034742945, 6565.638889861103, 6571.474282057328, 6098.451139397475, 6138.324784273816, 6190.783322583688, 6267.122602835698, 6330.651814150082], "value": 6084.034773171042, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [805.5891495337377, 818.1859050245007, 841.7979684875629, 867.3668222197791, 867.8220964702234, 38755.418668719954, 39400.2119957601, 39443.2111357773, 39522.40716389257, 39591.80204098976, 36179.09552261195, 36401.81799091001, 36476.0, 36499.81750091246, 36884.81557592208, 6844.31556844314, 6920.619365934872, 6947.444204463656, 6971.895421568681, 6994.265602111781, 6820.488463365243, 6939.791806245821, 6940.618265995368, 6941.861162776741, 6944.583325000516, 6898.896516552256, 7548.131964824061, 7670.731524396647, 7678.0786305643405, 7745.031871016123, 7673.923260767405, 7736.071671399468, 7739.9613001935195, 7746.186650401712, 7749.806254843646, 7432.219616940251, 7614.086309642823, 7616.428767842434, 7616.504927179715, 7618.162002179756, 38120.618793811984, 38545.421818672745, 38575.42136867949, 38604.0, 38643.227135457135, 3285.129440698217, 3285.227971426713, 3285.605727312714, 3299.373119107362, 3326.76712630116, 30821.69178308233, 30971.0, 31037.22406939822, 31043.379132417223, 31342.686573134204, 5090.974545127251, 5092.26162206478, 5116.462771409023, 5127.410347810012, 5142.151544995071, 183906.0, 184518.0, 184541.0, 185141.0, 185786.07106964514, 46286.305705414445, 46316.536834631894, 46362.76818615885, 46382.30426543605, 46384.5361546387, 47935.80160496016, 48527.27209091866, 48574.27138592924, 48593.514064859606, 48603.5139648599, 14365.497207597893, 14657.0, 14733.926330368495, 14736.48422305214, 14756.704865902837, 11799.35103569312, 11817.290962542274, 11822.586209482626, 11850.288982660895, 11853.5851245206, 13733.931330343285, 13760.587182384545, 13848.723025539633, 13888.236147011808, 14029.719405612035, 5527.226188333637, 5559.972200138974, 5639.577031722637, 5709.058005429058, 5726.9713651431475, 984.5372674842812, 985.1035557642654, 999.3004896572428, 1000.3597697473623, 1001.5493028137367, 22173.33479995603, 22258.554828903332, 22309.661420314835, 22412.66381004286, 22527.848714886237, 1099.4722533184117, 1102.895224953628, 1104.127739086113, 1105.3975583307117, 1119.261287550213, 15487.922560387125, 15550.300236489385, 15617.375304987674, 15959.202039897958, 16079.517614471584, 231282.0, 232945.0, 233046.0, 233049.0, 233402.0, 52627.47372526302, 55196.44803551913, 55673.72163139239, 56181.157282640794, 56306.43693563012, 1352.5991365326427, 1376.3187222325014, 1378.827646544182, 1384.9723005540034, 1420.2614640387148, 26888.865555672095, 27259.454810904066, 27340.863295683394, 27383.45233095287, 27858.0, 37782.62217377791, 38144.23711525698, 38163.42754858735, 38164.236715266095, 38215.426768597936, 209749.0, 211948.0, 212320.0, 212408.0, 213043.0, 33352.33295334128, 34490.655093448746, 34817.0, 34938.65061349456, 35325.470117947734, 41946.790266048476, 42147.3677894838, 42455.0, 42566.78716606521, 42743.0, 30792.384152317278, 30793.0, 30814.0, 30880.691193087783, 31595.84202078975, 30588.235294117825, 30811.691883080883, 30853.537196942514, 31084.844575776977, 31728.524072138476, 35286.29427411386, 35335.29329413346, 35612.46581301335, 35661.1084722884, 35699.64300357067, 29143.0, 29662.40675186441, 29816.850915745283, 29877.701222988362, 30832.0, 22562.661560076285, 22607.773922260567, 22741.545169096855, 24040.39899002539, 24994.625080623442], "value": 16878.86512972025, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [556.221290193729, 557.6849080269648, 559.6446256627042, 567.8296511046688, 576.7318197038377, 21334.679979800298, 22059.448513787163, 22148.55702885943, 22170.224042158527, 22171.6674249886, 22823.54352912941, 23529.41176470585, 25669.22992310229, 25890.48219035623, 25980.220593382182, 7157.176924653666, 7317.59753213573, 7320.560766354036, 7322.157951835554, 7328.816779580527, 6183.288921773986, 6881.931180688204, 7144.464165187605, 7150.213476517605, 7171.28287171284, 6839.555428897131, 6878.518503704742, 6882.3461771131915, 6885.277045910182, 6885.414739747128, 6746.561473504206, 6829.0, 6845.281245469228, 6873.690683919235, 6888.173419189729, 6744.42672372844, 6746.8313292167595, 6753.966230168818, 6760.188777346701, 6770.763023294161, 28546.857265713537, 29181.70818291811, 29318.41363172746, 30027.249318766986, 30711.38577228465, 2114.0486780948636, 2133.232036466871, 2137.925172618951, 2143.4427048967223, 2152.5910077085305, 19114.23543058276, 19794.109265083105, 19903.303384381477, 19935.80064199354, 19938.40184794444, 2464.260721783458, 2475.344033831036, 2542.8474291542566, 2586.094866796625, 2593.8054645901443, 133034.33482832622, 138518.30740846333, 138811.30594347065, 138917.61082389147, 138987.0, 18912.15395914228, 20508.0, 20995.47511312199, 21436.356909292746, 21610.0, 41423.7928810354, 41439.58560414357, 41450.0, 41457.378139327935, 41590.792046039576, 11005.284656497302, 11226.943865280622, 11245.212835101627, 11294.43527823622, 11341.206115571997, 9471.857922131036, 9487.383320084173, 9544.379615324982, 9557.761055973517, 9624.326297159132, 10287.273872423664, 10519.26365154432, 10546.367217966947, 11083.72290692723, 11572.6528204154, 3516.7889926604485, 3527.4179760339257, 3595.40675788492, 3795.373763329075, 4247.851325203603, 914.9359544831798, 944.3248077624531, 956.0, 964.2719746591418, 964.4695417520336, 19199.616007680048, 19416.12627431769, 19492.31776887802, 19710.90144549268, 20051.29820456277, 1029.763154474475, 1033.3696445168441, 1042.1714736784274, 1047.7537778622018, 1049.9580016799243, 10526.894731052591, 10595.788084238273, 10596.947015265028, 10773.407462589475, 10963.83554246671, 535832.0, 552401.0, 553071.0, 568172.0, 568427.0, 114662.0, 115150.42424787823, 117383.41308293404, 122039.0, 123427.68003119847, 1154.7748189103213, 1184.3367714080143, 1197.239752756988, 1201.3152503073165, 1214.611324376191, 16688.332466701682, 17071.658566828843, 17416.12919354002, 17481.300747970447, 17588.648227035643, 52700.20949685835, 53771.19343209777, 55157.448425515235, 55544.44455555393, 56184.719076404355, 69621.30378696148, 71822.28177718156, 72472.63763681147, 73196.63401682957, 73560.63219683868, 11315.943420282845, 11645.243059201124, 13653.112547684368, 13832.930835345758, 14119.576412707635, 21504.139834407073, 21666.89166554157, 21748.89125554362, 21785.67321490147, 21875.453113672287, 17390.913045435198, 17503.0, 17574.20916058755, 17891.28434862643, 18068.457946261635, 15979.760303595687, 16158.919205403898, 16364.590885227964, 16415.343386264416, 16600.50198494047, 17837.108144592978, 17972.640547188723, 18235.179416926007, 18331.266749329876, 18420.07899605041, 13835.10071845367, 13838.4464621414, 13911.513097041556, 13939.442422302995, 13946.860531394555, 17459.56351091233, 17613.0, 17781.733274000642, 17888.0, 17943.192556335256], "value": 12509.328465623123, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1303.876131767482, 1339.2299427829, 1366.0574203799383, 1368.0560413314813, 1389.034620938448, 14356.928215358921, 14924.0, 14976.326065327059, 14995.250237488122, 15002.924985375084, 14214.218217998006, 15209.695806083872, 15214.619634509143, 15221.695566088672, 15234.314455849486, 2658.056389981558, 2724.2916841621122, 2724.387012922087, 2726.6727992640913, 2727.836329820207, 2572.9228123156336, 2630.289821748127, 2661.7205193454697, 2704.9459010819774, 2729.331313828115, 2696.0563802669008, 2718.7009428962797, 2724.278066312429, 2753.8623068846578, 2754.476649436601, 2656.2031390582843, 2668.239551727748, 2700.9729902701015, 2711.945761084767, 2718.293243756618, 2537.5939849624156, 2575.5364034473787, 2591.028364363364, 2613.124603257911, 2615.5422801009936, 14520.128792272391, 14677.045992010591, 14678.486252981202, 14681.0, 14708.0, 7854.332381747558, 8171.387145964077, 8177.223163799489, 8179.345652347798, 8180.7954801130445, 5294.391145018334, 5441.945580544223, 5622.465865742748, 5634.0, 5638.210650508932, 1819.5724004858848, 1876.3432798520546, 1885.58517126232, 1922.8750131241563, 1928.151613290148, 25243.49513009748, 25630.359241019123, 25684.871575642377, 25726.48547029049, 25823.35441613956, 7028.648567571601, 7063.2583578724525, 7077.82305442368, 7314.3782778463365, 7342.339189472973, 19620.90189549043, 19629.411117666492, 19649.115789789495, 19655.410337689893, 19693.901530492254, 7660.578668173304, 7718.112417071996, 7766.728164514215, 7771.028621422322, 7772.378209743207, 6792.93207067923, 6952.2352541220425, 7091.574505529685, 7093.574385536885, 7187.820304492429, 4607.470140933769, 5122.590192784568, 5295.311609490742, 5352.678839269656, 5405.918816236768, 1425.4512012874911, 1501.5570406730042, 1522.6574020845442, 1525.0620868165997, 1526.198745658516, 827.9213474719892, 854.2269246332079, 864.7059999600166, 869.248100393168, 885.022050634053, 7748.4188685848785, 7912.337274572959, 7975.72084977023, 8014.559199243981, 8074.0, 986.8963758805365, 995.785906030207, 999.0858364596313, 1019.3781793106199, 1021.7445638590352, 4836.951630483721, 5228.7908483660985, 5257.894842103213, 5285.55072818807, 5486.683196032924, 19608.607827843647, 20170.89914550418, 21036.894815525826, 21255.256066037615, 21256.149754009668, 20813.1674733009, 20995.160193592084, 21070.367888963356, 21153.0, 21258.25596104129, 10497.842532362021, 10925.562977480971, 11108.944455277671, 11212.719682008015, 11295.0, 8161.591920403837, 8237.217464340878, 8318.209770071833, 8420.031696354752, 8503.107173746668, 17525.123743813012, 17778.199981000627, 17859.28562857523, 18008.099595019936, 18050.0, 18372.632547349247, 18387.080645967915, 18458.26166953307, 18476.630467390307, 18636.906815465834, 11771.764564708828, 11932.70168245766, 11949.0, 12088.637340879788, 12089.57686480969, 10930.726731831768, 11324.0, 13194.274314912773, 13357.332133393096, 13374.331283435984, 10209.591616335561, 10249.538770755185, 10460.26778125524, 10595.364278143028, 10788.190885683449, 9955.502224888582, 10249.12882405004, 10299.897001029894, 10333.070023697903, 10464.47677616101, 9770.462624555717, 10019.0, 10023.198144148304, 10024.047715467019, 10026.0, 7010.75462358815, 7020.719171233298, 7026.332498412643, 7032.753853615099, 7041.295870412918, 7151.8569628608175, 7157.320054594805, 7195.424366050599, 7210.206877243604, 7265.745698900513], "value": 6586.3573586705725, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [492.6108374384238, 495.27552802922025, 523.5000574451399, 524.5410266017235, 525.5296509623886, 6114.205153330066, 6142.662153581551, 6142.710030893518, 6173.969130154354, 6184.907226391597, 5810.709464526767, 6046.8488287792825, 6054.485368743662, 6106.687062281609, 6118.418750218733, 4866.0, 4887.2913427552985, 4896.657233993622, 4898.14282500561, 4926.753662316888, 4826.975865120669, 4896.167651499236, 4955.405351357842, 4960.131976904046, 4994.1260279451135, 4919.926201106986, 5026.949730502684, 5093.388793344804, 5113.156329205695, 5113.6931784092885, 5043.638217681242, 5065.746712664352, 5102.69383836971, 5119.66722163062, 5142.640015198937, 4724.71651700899, 4752.572268495852, 4805.279208118775, 4807.927881081787, 4841.467438581753, 6009.939900600982, 6018.8495287617725, 6078.726457309432, 6102.847428814271, 6122.28575998721, 5828.154917536934, 5901.8130209686715, 5930.169776231331, 5955.672438015908, 5979.1629171915965, 6508.446782023534, 6540.4767618590395, 6550.181227346582, 6590.670466476657, 6619.304972977864, 5144.0, 5175.560077393426, 5186.377634683824, 5196.700824793802, 5205.141151710001, 6715.832104197337, 6718.883551681205, 6853.9314606853795, 6855.622940738307, 6908.861822763567, 5227.294315267391, 5258.290130832365, 5284.497972692588, 5293.708846013506, 5320.521153096162, 5357.919631205535, 5364.892702145935, 5381.327334083239, 5403.70279634616, 5404.864878378072, 5707.800226992118, 5722.685252311163, 5739.713014349266, 5774.884502310014, 5830.329512106077, 6331.651759153198, 6390.265119511223, 6416.807495775134, 6445.51658625605, 6508.544401891917, 1755.9824401756075, 1783.5897743519063, 1809.8461630761533, 1815.4916623345484, 1882.6611209982061, 1375.3879523611897, 1392.718698797109, 1403.6280385697798, 1414.6463384153963, 1421.7085497472992, 5533.280673512418, 5547.472990065938, 5555.8888822223325, 5675.631083979528, 5695.629784064023, 6366.681665916778, 6381.680915954184, 6416.615003099829, 6482.902756458657, 6528.225504160712, 5645.971770141123, 5705.62913410627, 5705.885882282331, 5730.684812335278, 5748.540116790647, 3473.2879759649213, 3484.581850177995, 3491.738119641037, 3515.5957064937347, 3527.417976033977, 6269.247690277196, 6308.044506203092, 6314.0, 6321.026629834762, 6437.742490300429, 6677.0, 6681.6302657955, 6743.696533655997, 6788.898166527506, 6789.219239787488, 6373.139626150411, 6385.0, 6446.871062578723, 6467.514936379696, 6474.611523308617, 6491.221053473425, 6549.181352330958, 6578.8553211478375, 6604.0, 6669.2997235289595, 6480.675966201766, 6508.086394771917, 6515.348465153446, 6587.736490540325, 6655.367740064686, 6337.809865704036, 6349.365063493614, 6386.221993432871, 6387.425131738166, 6448.451881590117, 4839.927401088916, 4878.268259761065, 4889.804407823647, 4899.657024008286, 4928.827491037797, 6541.149650545399, 6579.17760279965, 6628.867422651617, 6657.800265991834, 6660.0, 6080.543959202989, 6242.719077641426, 6258.311585725475, 6261.279952805486, 6277.587542803016, 6253.09330147117, 6261.405166509175, 6271.62370257786, 6325.703230837759, 6407.455366293731, 6195.938040619536, 6235.532335074797, 6264.655443950626, 6382.234131904015, 6389.55273130895, 6174.924549797112, 6358.979484744709, 6381.649009304533, 6412.39082287182, 6578.144841170809, 6066.1507388966465, 6158.105690325539, 6163.907541386972, 6178.505719542336, 6288.591241569284], "value": 5053.446863952201, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [840.9537475438848, 868.6481974800206, 869.9434536755107, 872.4808738800414, 878.657323643779, 18490.81509184908, 19334.226630934765, 19407.12667929943, 19418.80581194186, 20501.897490512525, 20290.797092029075, 20839.895800520975, 20996.160153593875, 21155.894220528913, 21227.68158477624, 881.7531091294431, 909.2544113826632, 909.790748127931, 912.9315301352392, 913.0, 911.4759013567192, 946.6781294359917, 955.5652178258875, 958.702802131338, 959.4818797849153, 990.1979396688669, 1002.5187909803299, 1002.5989604158322, 1002.8495725641139, 1002.8997100289986, 999.6801023672427, 1000.0149852395384, 1000.6997900629782, 1000.9199264058894, 1001.4642166440956, 727.4907564704675, 727.803493056877, 728.0644371981978, 728.5774250934498, 728.7012324946746, 18820.905895470434, 19130.617387652168, 19231.903840480707, 19320.32378866747, 19341.12964916582, 19496.122674479684, 19576.119074641676, 20205.595888082156, 20527.281545145997, 20593.07331170101, 15505.457308994244, 15997.20013999307, 16019.91990040054, 16087.517374478784, 16214.351425942948, 3574.0, 3627.2020155565997, 3630.455431685242, 3630.80030598317, 3632.4551317302353, 127385.0, 129904.0, 131458.0, 131638.6836131636, 133136.0, 15912.204389780465, 16124.435644752612, 16402.589935251715, 16413.343466261456, 16467.0, 28117.43765124686, 29062.0, 30026.399472010875, 30048.69951300459, 30054.69945300519, 8726.650933962697, 8967.058458861726, 8977.865332020025, 9007.324450666227, 9010.279177665901, 4098.4876890388705, 4206.0, 4207.76857272853, 4207.8316867325575, 4211.136716973013, 4751.3348131261655, 4812.614990800727, 4814.422269327633, 4816.470188279286, 4816.494268101869, 951.0774548687762, 957.2724729205714, 970.737900766789, 971.9659811906549, 985.0543478260806, 650.8470509430375, 681.0533358631507, 681.8465845184893, 689.0663151429841, 692.9549579277331, 11427.314361138193, 11789.465264968074, 11812.350320732443, 12099.57651482194, 12567.93716031414, 677.5900580149038, 680.4182424027484, 692.4806395203598, 693.9132608423947, 696.3489137656308, 5668.603197776116, 5763.740631671585, 6144.692765361803, 6192.318844927055, 6370.394812492806, 109977.0, 113981.43009284901, 115747.0, 116876.41561792306, 117682.0, 95599.0, 99257.02971881189, 101883.0, 103232.0, 103487.0, 88041.11958880458, 88911.11088889158, 89174.10825891657, 90960.54519727359, 91013.0, 12134.575289864812, 12149.696257593278, 12262.20295680778, 12424.316662583284, 12546.0, 39336.40995385129, 39494.40758388684, 39633.0, 40555.1888962225, 40699.59300406958, 70956.64521677358, 72023.0, 72164.63917680379, 72297.0, 75299.62350188215, 18777.812221878154, 18804.811951880853, 18930.14814333386, 18953.71569426432, 19198.424047278604, 20886.582268354243, 21038.263660772413, 21186.576268474237, 21233.36299911005, 21385.89307053455, 16307.673846523241, 16966.0, 17022.48932532026, 17116.828831711522, 17638.91180544089, 17854.0, 18120.18459169314, 18399.908000459913, 18406.447806565826, 18604.534886627942, 16463.91768041152, 16645.50063498097, 16925.746113808058, 17012.149392530075, 17063.0, 13037.934810326267, 13150.21098734079, 13189.736205275649, 13353.732925341244, 13396.397162127532, 14424.927875360556, 14537.636559085684, 14700.70598588001, 14724.411023558938, 14746.262686865828], "value": 9045.352036214439, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1502.9000000000003, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [99.0, 110.0, 106.0, 107.0, 109.0, 114.0, 110.0, 101.0, 107.0, 107.0], "value": 107.0, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 118.0, 153.0, 176.0, 123.0, 150.0, 152.0, 118.0, 178.0, 123.0], "value": 143.9, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [164.0, 164.0, 164.0, 161.0, 168.0, 163.0, 179.0, 161.0, 167.0, 163.0], "value": 165.4, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [74.0, 73.0, 74.0, 177.0, 77.0, 73.0, 73.0, 93.0, 96.0, 75.0], "value": 88.5, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 79.0, 128.0, 78.0, 78.0, 78.0, 124.0, 78.0, 80.0, 129.0], "value": 93.7, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [113.0, 113.0, 118.0, 114.0, 114.0, 114.0, 117.0, 118.0, 118.0, 118.0], "value": 115.7, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 147.0, 148.0, 148.0, 150.0, 149.0, 148.0, 147.0, 151.0, 149.0], "value": 148.5, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 93.0, 94.0, 94.0, 97.0, 94.0, 94.0, 93.0, 93.0, 94.0], "value": 94.0, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [51.0, 53.0, 55.0, 61.0, 57.0, 53.0, 53.0, 50.0, 52.0, 55.0], "value": 54.0, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [55.0, 54.0, 54.0, 55.0, 59.0, 55.0, 55.0, 56.0, 54.0, 55.0], "value": 55.2, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 84.0, 75.0, 73.0, 74.0, 73.0, 73.0, 73.0, 73.0, 77.0], "value": 75.0, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [126.0, 121.0, 118.0, 118.0, 115.0, 122.0, 121.0, 119.0, 117.0, 167.0], "value": 124.4, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [177.0, 171.0, 171.0, 167.0, 169.0, 172.0, 177.0, 167.0, 167.0, 184.0], "value": 172.2, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [71.0, 63.0, 64.0, 71.0, 63.0, 65.0, 65.0, 66.0, 64.0, 62.0], "value": 65.4, "unit": "score"}]}]} 18:25:28 INFO - Return code: 0 18:25:28 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 18:25:28 INFO - # TBPL SUCCESS # 18:25:28 INFO - Running post-action listener: _package_coverage_data 18:25:28 INFO - Running post-action listener: _resource_record_post_action 18:25:28 INFO - [mozharness: 2017-08-23 01:25:28.909884Z] Finished run-tests step (success) 18:25:28 INFO - Running post-run listener: _resource_record_post_run 18:25:28 INFO - Total resource usage - Wall time: 1193s; CPU: 13.0%; Read bytes: 4096; Write bytes: 453029888; Read time: 12; Write time: 302828 18:25:28 INFO - TinderboxPrint: CPU usage
13.1% 18:25:28 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 12 18:25:28 INFO - TinderboxPrint: I/O write bytes / time
453,029,888 / 302,828 18:25:28 INFO - TinderboxPrint: CPU idle
8,259.8 (86.8%) 18:25:28 INFO - TinderboxPrint: CPU user
1,198.0 (12.6%) 18:25:28 INFO - TinderboxPrint: Swap in / out
0 / 0 18:25:28 INFO - install - Wall time: 18s; CPU: 13.0%; Read bytes: 0; Write bytes: 115318784; Read time: 0; Write time: 104992 18:25:28 INFO - setup-mitmproxy - Wall time: 0s; CPU: Can't collect data; Read bytes: 0; Write bytes: 0; Read time: 0; Write time: 0 18:25:29 INFO - run-tests - Wall time: 1175s; CPU: 13.0%; Read bytes: 0; Write bytes: 337166336; Read time: 0; Write time: 197828 18:25:29 INFO - Running post-run listener: _upload_blobber_files 18:25:29 INFO - Blob upload gear active. 18:25:29 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 18:25:29 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 18:25:29 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Firefox', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 18:25:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Firefox -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 18:25:29 INFO - (blobuploader) - INFO - Open directory for files ... 18:25:29 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 18:25:29 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 18:25:29 INFO - (blobuploader) - INFO - Uploading, attempt #1. 18:25:30 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 18:25:30 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 18:25:30 INFO - (blobuploader) - INFO - Done attempting. 18:25:30 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 18:25:30 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 18:25:30 INFO - (blobuploader) - INFO - Uploading, attempt #1. 18:25:33 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 18:25:33 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 18:25:33 INFO - (blobuploader) - INFO - Done attempting. 18:25:33 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 18:25:33 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 18:25:33 INFO - (blobuploader) - INFO - Uploading, attempt #1. 18:25:34 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 18:25:34 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 18:25:34 INFO - (blobuploader) - INFO - Done attempting. 18:25:34 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 18:25:34 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 18:25:34 INFO - (blobuploader) - INFO - Uploading, attempt #1. 18:25:35 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 18:25:35 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 18:25:35 INFO - (blobuploader) - INFO - Done attempting. 18:25:35 INFO - (blobuploader) - INFO - Iteration through files over. 18:25:35 INFO - Return code: 0 18:25:35 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 18:25:35 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 18:25:35 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/f979bf90851618f40c464b701e899c8e9baca3a69b85bf54543c9f20bacd8379bc3d0f1b1cf3467d059dbd1c01a6f2671b465bfedc0e9b46f2520b2a52320d96", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/513659887db9b2eadd88a74a6a5d7f2e87d41a3489923b3089cc42077b1bb7cefd14b7f63e18bd376d689ec20b5816e620bb24442e15a0916b841a2c1cf2998a", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/f3ba97111b8c67fd5db8f4f2c6d06c700a2689527537479d8b691d914291d7d7fa457a6b4fc6bc674f1df2a030846b6e932d07ff2c57ff4cf594110d6a10d2a9", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/ba1cea898d787d63ee3bd0267d6acfc8a82aa6b1971526538a89ca6d0116af7dcf3c28eb67b413658576557970706da787fcefa955388122a48db0499cd3058c"} 18:25:35 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 18:25:35 INFO - Writing to file /builds/slave/test/properties/blobber_files 18:25:35 INFO - Contents: 18:25:35 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/f979bf90851618f40c464b701e899c8e9baca3a69b85bf54543c9f20bacd8379bc3d0f1b1cf3467d059dbd1c01a6f2671b465bfedc0e9b46f2520b2a52320d96", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/513659887db9b2eadd88a74a6a5d7f2e87d41a3489923b3089cc42077b1bb7cefd14b7f63e18bd376d689ec20b5816e620bb24442e15a0916b841a2c1cf2998a", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/f3ba97111b8c67fd5db8f4f2c6d06c700a2689527537479d8b691d914291d7d7fa457a6b4fc6bc674f1df2a030846b6e932d07ff2c57ff4cf594110d6a10d2a9", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/ba1cea898d787d63ee3bd0267d6acfc8a82aa6b1971526538a89ca6d0116af7dcf3c28eb67b413658576557970706da787fcefa955388122a48db0499cd3058c"} 18:25:35 INFO - Running post-run listener: copy_logs_to_upload_dir 18:25:35 INFO - Copying logs to upload dir... 18:25:35 INFO - mkdir: /builds/slave/test/build/upload/logs 18:25:35 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1250.417474 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 50 secs) (at 2017-08-22 18:25:35.285977) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-08-22 18:25:35.290060) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=4300f881736b422476174874000001bc-1503450282.909478-95939596 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/f979bf90851618f40c464b701e899c8e9baca3a69b85bf54543c9f20bacd8379bc3d0f1b1cf3467d059dbd1c01a6f2671b465bfedc0e9b46f2520b2a52320d96", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/513659887db9b2eadd88a74a6a5d7f2e87d41a3489923b3089cc42077b1bb7cefd14b7f63e18bd376d689ec20b5816e620bb24442e15a0916b841a2c1cf2998a", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/f3ba97111b8c67fd5db8f4f2c6d06c700a2689527537479d8b691d914291d7d7fa457a6b4fc6bc674f1df2a030846b6e932d07ff2c57ff4cf594110d6a10d2a9", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/ba1cea898d787d63ee3bd0267d6acfc8a82aa6b1971526538a89ca6d0116af7dcf3c28eb67b413658576557970706da787fcefa955388122a48db0499cd3058c"} build_url:https://queue.taskcluster.net/v1/task/IbzxS1zGRz6yU7eidXiiKg/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011459 build_url: 'https://queue.taskcluster.net/v1/task/IbzxS1zGRz6yU7eidXiiKg/artifacts/public/build/target.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/f979bf90851618f40c464b701e899c8e9baca3a69b85bf54543c9f20bacd8379bc3d0f1b1cf3467d059dbd1c01a6f2671b465bfedc0e9b46f2520b2a52320d96", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/513659887db9b2eadd88a74a6a5d7f2e87d41a3489923b3089cc42077b1bb7cefd14b7f63e18bd376d689ec20b5816e620bb24442e15a0916b841a2c1cf2998a", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/f3ba97111b8c67fd5db8f4f2c6d06c700a2689527537479d8b691d914291d7d7fa457a6b4fc6bc674f1df2a030846b6e932d07ff2c57ff4cf594110d6a10d2a9", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/ba1cea898d787d63ee3bd0267d6acfc8a82aa6b1971526538a89ca6d0116af7dcf3c28eb67b413658576557970706da787fcefa955388122a48db0499cd3058c"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-08-22 18:25:35.320453) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-08-22 18:25:35.320877) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=4300f881736b422476174874000001bc-1503450282.909478-95939596 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004489 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-08-22 18:25:35.403177) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-08-22 18:25:35.403499) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-08-22 18:25:35.403782) ========= ========= Total master_lag: 0.19 =========